builder: b2g-inbound_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-039 starttime: 1447692082.36 results: success (0) buildid: 20151116075758 builduid: 707a9795e2b2465dbb74512ec7a85be4 revision: 9143161fa821bce46c9d4ce47ed4882e92330656 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.361331) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.361820) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.362506) ========= bash -c pwd in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447691731.338944-2088164858 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006483 basedir: '/builds/slave/test' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.402555) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.402872) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.431977) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.432286) ========= rm -rf properties in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447691731.338944-2088164858 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004605 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.484677) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.484980) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.485374) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.485694) ========= 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/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447691731.338944-2088164858 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-16 08:41:22-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 44.0M=0s 2015-11-16 08:41:23 (44.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.212267 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.710161) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.710503) ========= rm -rf scripts in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447691731.338944-2088164858 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017507 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.759897) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:22.760287) ========= bash -c 'python archiver_client.py mozharness --repo integration/b2g-inbound --rev 9143161fa821bce46c9d4ce47ed4882e92330656 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/b2g-inbound --rev 9143161fa821bce46c9d4ce47ed4882e92330656 --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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447691731.338944-2088164858 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-16 08:41:23,300 truncating revision to first 12 chars 2015-11-16 08:41:23,300 Setting DEBUG logging. 2015-11-16 08:41:23,300 attempt 1/10 2015-11-16 08:41:23,300 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/b2g-inbound/9143161fa821?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-16 08:41:23,725 unpacking tar archive at: b2g-inbound-9143161fa821/testing/mozharness/ program finished with exit code 0 elapsedTime=0.745178 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:23.518043) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:23.518380) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:23.611027) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:23.611525) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-16 08:41:23.612087) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 4 secs) (at 2015-11-16 08:41:23.612459) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'B2G-Inbound-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'B2G-Inbound-Non-PGO'] 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/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447691731.338944-2088164858 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:41:24 INFO - MultiFileLogger online at 20151116 08:41:24 in /builds/slave/test 08:41:24 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound-Non-PGO 08:41:24 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:41:24 INFO - {'append_to_log': False, 08:41:24 INFO - 'base_work_dir': '/builds/slave/test', 08:41:24 INFO - 'blob_upload_branch': 'B2G-Inbound-Non-PGO', 08:41:24 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:41:24 INFO - 'branch': 'B2G-Inbound-Non-PGO', 08:41:24 INFO - 'buildbot_json_path': 'buildprops.json', 08:41:24 INFO - 'config_files': ('talos/linux_config.py',), 08:41:24 INFO - 'default_actions': ('clobber', 08:41:24 INFO - 'read-buildbot-config', 08:41:24 INFO - 'download-and-extract', 08:41:24 INFO - 'populate-webroot', 08:41:24 INFO - 'create-virtualenv', 08:41:24 INFO - 'install', 08:41:24 INFO - 'run-tests'), 08:41:24 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:41:24 INFO - 'download_minidump_stackwalk': True, 08:41:24 INFO - 'download_symbols': 'ondemand', 08:41:24 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:41:24 INFO - 'tooltool.py': '/tools/tooltool.py', 08:41:24 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:41:24 INFO - '/tools/misc-python/virtualenv.py')}, 08:41:24 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:41:24 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:41:24 INFO - 'installer_path': 'installer.exe', 08:41:24 INFO - 'log_level': 'info', 08:41:24 INFO - 'log_name': 'talos', 08:41:24 INFO - 'log_to_console': True, 08:41:24 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:41:24 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:41:24 INFO - 'opt_config_files': (), 08:41:24 INFO - 'pip_index': False, 08:41:24 INFO - 'sps_profile': False, 08:41:24 INFO - 'sps_profile_interval': 0, 08:41:24 INFO - 'suite': 'dromaeojs', 08:41:24 INFO - 'system_bits': '64', 08:41:24 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:41:24 INFO - 'title': 'talos-linux64-ix-039', 08:41:24 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:41:24 INFO - 'use_talos_json': True, 08:41:24 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:41:24 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:41:24 INFO - 'work_dir': 'build'} 08:41:24 INFO - ##### 08:41:24 INFO - ##### Running clobber step. 08:41:24 INFO - ##### 08:41:24 INFO - Running pre-action listener: _resource_record_pre_action 08:41:24 INFO - Running main action method: clobber 08:41:24 INFO - rmtree: /builds/slave/test/build 08:41:24 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:41:24 INFO - Running post-action listener: _resource_record_post_action 08:41:24 INFO - ##### 08:41:24 INFO - ##### Running read-buildbot-config step. 08:41:24 INFO - ##### 08:41:24 INFO - Running pre-action listener: _resource_record_pre_action 08:41:24 INFO - Running main action method: read_buildbot_config 08:41:24 INFO - Using buildbot properties: 08:41:24 INFO - { 08:41:24 INFO - "properties": { 08:41:24 INFO - "buildnumber": 191, 08:41:24 INFO - "product": "firefox", 08:41:24 INFO - "script_repo_revision": "production", 08:41:24 INFO - "builddir": "b2g-inbound_ubuntu64_hw_test-dromaeojs", 08:41:24 INFO - "repository": "", 08:41:24 INFO - "buildername": "Ubuntu HW 12.04 x64 b2g-inbound talos dromaeojs", 08:41:24 INFO - "buildid": "20151116075758", 08:41:24 INFO - "slavename": "talos-linux64-ix-039", 08:41:24 INFO - "pgo_build": "False", 08:41:24 INFO - "basedir": "/builds/slave/test", 08:41:24 INFO - "project": "", 08:41:24 INFO - "platform": "ubuntu64_hw", 08:41:24 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 08:41:24 INFO - "slavebuilddir": "test", 08:41:24 INFO - "scheduler": "tests-b2g-inbound-linux64-talos", 08:41:24 INFO - "branch": "b2g-inbound", 08:41:24 INFO - "repo_path": "integration/b2g-inbound", 08:41:24 INFO - "stage_platform": "linux64", 08:41:24 INFO - "builduid": "707a9795e2b2465dbb74512ec7a85be4", 08:41:24 INFO - "revision": "9143161fa821bce46c9d4ce47ed4882e92330656" 08:41:24 INFO - }, 08:41:24 INFO - "sourcestamp": { 08:41:24 INFO - "repository": "", 08:41:24 INFO - "hasPatch": false, 08:41:24 INFO - "project": "", 08:41:24 INFO - "branch": "b2g-inbound-linux64-talos", 08:41:24 INFO - "changes": [ 08:41:24 INFO - { 08:41:24 INFO - "category": null, 08:41:24 INFO - "files": [ 08:41:24 INFO - { 08:41:24 INFO - "url": null, 08:41:24 INFO - "name": "https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 08:41:24 INFO - } 08:41:24 INFO - ], 08:41:24 INFO - "repository": "", 08:41:24 INFO - "rev": "9143161fa821bce46c9d4ce47ed4882e92330656", 08:41:24 INFO - "who": "cbook@mozilla.com", 08:41:24 INFO - "when": 1447692020, 08:41:24 INFO - "number": 6666546, 08:41:24 INFO - "comments": "Bug 1224897 - Update list of important manifests r=rail", 08:41:24 INFO - "project": "", 08:41:24 INFO - "at": "Mon 16 Nov 2015 08:40:20", 08:41:24 INFO - "branch": "b2g-inbound-linux64-talos", 08:41:24 INFO - "revlink": "", 08:41:24 INFO - "properties": [ 08:41:24 INFO - [ 08:41:24 INFO - "buildid", 08:41:24 INFO - "20151116075758", 08:41:24 INFO - "Change" 08:41:24 INFO - ], 08:41:24 INFO - [ 08:41:24 INFO - "builduid", 08:41:24 INFO - "707a9795e2b2465dbb74512ec7a85be4", 08:41:24 INFO - "Change" 08:41:24 INFO - ], 08:41:24 INFO - [ 08:41:24 INFO - "pgo_build", 08:41:24 INFO - "False", 08:41:24 INFO - "Change" 08:41:24 INFO - ] 08:41:24 INFO - ], 08:41:24 INFO - "revision": "9143161fa821bce46c9d4ce47ed4882e92330656" 08:41:24 INFO - } 08:41:24 INFO - ], 08:41:24 INFO - "revision": "9143161fa821bce46c9d4ce47ed4882e92330656" 08:41:24 INFO - } 08:41:24 INFO - } 08:41:24 INFO - Found installer url https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 08:41:24 INFO - Running post-action listener: _resource_record_post_action 08:41:24 INFO - ##### 08:41:24 INFO - ##### Running download-and-extract step. 08:41:24 INFO - ##### 08:41:24 INFO - Running pre-action listener: _resource_record_pre_action 08:41:24 INFO - Running main action method: download_and_extract 08:41:24 INFO - mkdir: /builds/slave/test/build/tests 08:41:24 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')]} 08:41:24 INFO - https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 08:41:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/test_packages.json 08:41:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/test_packages.json 08:41:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 08:41:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 08:41:27 INFO - Downloaded 1302 bytes. 08:41:27 INFO - Reading from file /builds/slave/test/build/test_packages.json 08:41:27 INFO - Using the following test package requirements: 08:41:27 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 08:41:27 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:27 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 08:41:27 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:27 INFO - u'jsshell-linux-x86_64.zip'], 08:41:27 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:27 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 08:41:27 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 08:41:27 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:27 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 08:41:27 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:27 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 08:41:27 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:27 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 08:41:27 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 08:41:27 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 08:41:27 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 08:41:27 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:41:27 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')]} 08:41:27 INFO - https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:41:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:41:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:41:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:41:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:41:28 INFO - Downloaded 21278264 bytes. 08:41:28 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 08:41:28 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:41:28 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 08:41:29 INFO - Return code: 0 08:41:29 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 08:41:29 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')]} 08:41:29 INFO - https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:41:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:41:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:41:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:41:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:41:30 INFO - Downloaded 21278264 bytes. 08:41:30 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 08:41:30 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 08:41:30 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 08:41:32 INFO - Return code: 0 08:41:32 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')]} 08:41:32 INFO - https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 08:41:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 08:41:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 08:41:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 08:41:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 08:41:33 INFO - Downloaded 11131693 bytes. 08:41:33 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 08:41:33 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 08:41:33 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 08:41:33 INFO - Return code: 0 08:41:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:33 INFO - https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 08:41:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 08:41:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 08:41:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 08:41:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 08:41:37 INFO - Downloaded 55605789 bytes. 08:41:37 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 08:41:37 INFO - mkdir: /builds/slave/test/properties 08:41:37 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:41:37 INFO - Writing to file /builds/slave/test/properties/build_url 08:41:37 INFO - Contents: 08:41:37 INFO - build_url:https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 08:41:37 INFO - Running post-action listener: _resource_record_post_action 08:41:37 INFO - Running post-action listener: set_extra_try_arguments 08:41:37 INFO - ##### 08:41:37 INFO - ##### Running populate-webroot step. 08:41:37 INFO - ##### 08:41:37 INFO - Running pre-action listener: _resource_record_pre_action 08:41:37 INFO - Running main action method: populate_webroot 08:41:37 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:41:37 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:41:37 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 08:41:37 INFO - '../fennec_ids.txt'], 08:41:37 INFO - 'tests': ['tcheck2']}, 08:41:37 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:41:37 INFO - '--tppagecycles', 08:41:37 INFO - '7'], 08:41:37 INFO - 'tests': ['tsvgm']}}, 08:41:37 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 08:41:37 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 08:41:37 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:41:37 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 08:41:37 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 08:41:37 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 08:41:37 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:37 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:41:37 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:37 INFO - 'talos_options': ['--e10s'], 08:41:37 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:41:37 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:37 INFO - 'tests': ['damp', 'tps']}, 08:41:37 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:37 INFO - 'talos_options': ['--e10s'], 08:41:37 INFO - 'tests': ['damp', 'tps']}, 08:41:37 INFO - 'g3': {'tests': ['dromaeo_dom']}, 08:41:37 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:41:37 INFO - 'other': {'tests': ['a11yr', 08:41:37 INFO - 'ts_paint', 08:41:37 INFO - 'tpaint', 08:41:37 INFO - 'sessionrestore', 08:41:37 INFO - 'sessionrestore_no_auto_restore']}, 08:41:37 INFO - 'other-e10s': {'talos_options': ['--e10s'], 08:41:37 INFO - 'tests': ['a11yr', 08:41:37 INFO - 'ts_paint', 08:41:37 INFO - 'tpaint', 08:41:37 INFO - 'sessionrestore', 08:41:37 INFO - 'sessionrestore_no_auto_restore']}, 08:41:37 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 08:41:37 INFO - 'tests': ['a11yr', 08:41:37 INFO - 'ts_paint', 08:41:37 INFO - 'tpaint', 08:41:37 INFO - 'sessionrestore', 08:41:37 INFO - 'sessionrestore_no_auto_restore']}, 08:41:37 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 08:41:37 INFO - 'tests': ['a11yr', 08:41:37 INFO - 'ts_paint', 08:41:37 INFO - 'tpaint', 08:41:37 INFO - 'sessionrestore', 08:41:37 INFO - 'sessionrestore_no_auto_restore']}, 08:41:37 INFO - 'other_l64': {'tests': ['a11yr', 08:41:37 INFO - 'ts_paint', 08:41:37 INFO - 'tpaint', 08:41:37 INFO - 'sessionrestore', 08:41:37 INFO - 'sessionrestore_no_auto_restore']}, 08:41:37 INFO - 'other_nol64': {'tests': ['a11yr', 08:41:37 INFO - 'ts_paint', 08:41:37 INFO - 'tpaint', 08:41:37 INFO - 'sessionrestore', 08:41:37 INFO - 'sessionrestore_no_auto_restore']}, 08:41:37 INFO - 'svgr': {'tests': ['tsvgx', 08:41:37 INFO - 'tsvgr_opacity', 08:41:37 INFO - 'tart', 08:41:37 INFO - 'tscrollx', 08:41:37 INFO - 'cart']}, 08:41:37 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 08:41:37 INFO - 'tests': ['tsvgx', 08:41:37 INFO - 'tsvgr_opacity', 08:41:37 INFO - 'tart', 08:41:37 INFO - 'tscrollx', 08:41:37 INFO - 'cart']}, 08:41:37 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:37 INFO - 'tests': ['tp5o']}, 08:41:37 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:37 INFO - 'talos_options': ['--e10s'], 08:41:37 INFO - 'tests': ['tp5o']}, 08:41:37 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:37 INFO - 'talos_options': ['--xperf_path', 08:41:37 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:41:37 INFO - 'tests': ['tp5n']}, 08:41:37 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:41:37 INFO - 'talos_options': ['--e10s', 08:41:37 INFO - '--xperf_path', 08:41:37 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:41:37 INFO - 'tests': ['tp5n']}}, 08:41:37 INFO - 'talos.zip': {'path': '', 08:41:37 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:41:37 INFO - Running post-action listener: _resource_record_post_action 08:41:37 INFO - ##### 08:41:37 INFO - ##### Running create-virtualenv step. 08:41:37 INFO - ##### 08:41:37 INFO - Running pre-action listener: _resource_record_pre_action 08:41:37 INFO - Running main action method: create_virtualenv 08:41:37 INFO - Creating virtualenv /builds/slave/test/build/venv 08:41:37 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 08:41:37 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:41:37 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:41:37 INFO - Using real prefix '/usr' 08:41:37 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:41:37 INFO - Installing distribute.............................................................................................................................................................................................done. 08:41:39 INFO - Installing pip.................done. 08:41:39 INFO - Return code: 0 08:41:39 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:41:39 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')]} 08:41:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:39 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')]} 08:41:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:39 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/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 0x7feaa0abec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a146c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ac59a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b54ac0>, '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 0x1b559a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b55e50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 08:41:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/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/build 08:41:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/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 08:41:39 INFO - Using env: {'DISPLAY': ':0', 08:41:39 INFO - 'HOME': '/home/cltbld', 08:41:39 INFO - 'LANG': 'en_US.UTF-8', 08:41:39 INFO - 'LANGUAGE': 'en_US:en', 08:41:39 INFO - 'LOGNAME': 'cltbld', 08:41:39 INFO - 'MAIL': '/var/mail/cltbld', 08:41:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:39 INFO - 'MOZ_NO_REMOTE': '1', 08:41:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:39 INFO - 'NO_EM_RESTART': '1', 08:41:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:39 INFO - 'PWD': '/builds/slave/test', 08:41:39 INFO - 'SHELL': '/bin/bash', 08:41:39 INFO - 'SHLVL': '1', 08:41:39 INFO - 'TERM': 'linux', 08:41:39 INFO - 'TMOUT': '86400', 08:41:39 INFO - 'USER': 'cltbld', 08:41:39 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', 08:41:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:39 INFO - '_': '/tools/buildbot/bin/python'} 08:41:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:39 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 08:41:39 INFO - Cleaning up... 08:41:39 INFO - Return code: 0 08:41:39 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 08:41:39 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')]} 08:41:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:39 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')]} 08:41:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:39 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/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 0x7feaa0abec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a146c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ac59a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b54ac0>, '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 0x1b559a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b55e50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 08:41:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/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/build 08:41:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/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 08:41:39 INFO - Using env: {'DISPLAY': ':0', 08:41:39 INFO - 'HOME': '/home/cltbld', 08:41:39 INFO - 'LANG': 'en_US.UTF-8', 08:41:39 INFO - 'LANGUAGE': 'en_US:en', 08:41:39 INFO - 'LOGNAME': 'cltbld', 08:41:39 INFO - 'MAIL': '/var/mail/cltbld', 08:41:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:39 INFO - 'MOZ_NO_REMOTE': '1', 08:41:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:39 INFO - 'NO_EM_RESTART': '1', 08:41:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:39 INFO - 'PWD': '/builds/slave/test', 08:41:39 INFO - 'SHELL': '/bin/bash', 08:41:39 INFO - 'SHLVL': '1', 08:41:39 INFO - 'TERM': 'linux', 08:41:39 INFO - 'TMOUT': '86400', 08:41:39 INFO - 'USER': 'cltbld', 08:41:39 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', 08:41:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:39 INFO - '_': '/tools/buildbot/bin/python'} 08:41:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:40 INFO - Downloading/unpacking psutil>=0.7.1 08:41:40 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 08:41:40 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 08:41:40 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 08:41:40 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 08:41:40 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 08:41:40 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 08:41:41 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 08:41:41 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 08:41:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:41:41 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:41:41 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:41:41 INFO - Installing collected packages: psutil 08:41:41 INFO - Running setup.py install for psutil 08:41:41 INFO - building 'psutil._psutil_linux' extension 08:41:41 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 08:41:42 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 08:41:42 INFO - building 'psutil._psutil_posix' extension 08:41:42 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 08:41:42 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 08:41:42 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:41:42 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:41:42 INFO - Successfully installed psutil 08:41:42 INFO - Cleaning up... 08:41:42 INFO - Return code: 0 08:41:42 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 08:41:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/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 0x7feaa0abec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a146c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ac59a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b54ac0>, '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 0x1b559a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b55e50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 08:41:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/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/build 08:41:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/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 08:41:42 INFO - Using env: {'DISPLAY': ':0', 08:41:42 INFO - 'HOME': '/home/cltbld', 08:41:42 INFO - 'LANG': 'en_US.UTF-8', 08:41:42 INFO - 'LANGUAGE': 'en_US:en', 08:41:42 INFO - 'LOGNAME': 'cltbld', 08:41:42 INFO - 'MAIL': '/var/mail/cltbld', 08:41:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:42 INFO - 'MOZ_NO_REMOTE': '1', 08:41:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:42 INFO - 'NO_EM_RESTART': '1', 08:41:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:42 INFO - 'PWD': '/builds/slave/test', 08:41:42 INFO - 'SHELL': '/bin/bash', 08:41:42 INFO - 'SHLVL': '1', 08:41:42 INFO - 'TERM': 'linux', 08:41:42 INFO - 'TMOUT': '86400', 08:41:42 INFO - 'USER': 'cltbld', 08:41:42 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', 08:41:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:42 INFO - '_': '/tools/buildbot/bin/python'} 08:41:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:42 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 08:41:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:44 INFO - Downloading mozsystemmonitor-0.0.tar.gz 08:41:44 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 08:41:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:41:44 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 08:41:44 INFO - Installing collected packages: mozsystemmonitor 08:41:44 INFO - Running setup.py install for mozsystemmonitor 08:41:44 INFO - Successfully installed mozsystemmonitor 08:41:44 INFO - Cleaning up... 08:41:44 INFO - Return code: 0 08:41:44 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:41:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:44 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/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 0x7feaa0abec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a146c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ac59a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b54ac0>, '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 0x1b559a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b55e50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 08:41:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/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/build 08:41:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/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 08:41:44 INFO - Using env: {'DISPLAY': ':0', 08:41:44 INFO - 'HOME': '/home/cltbld', 08:41:44 INFO - 'LANG': 'en_US.UTF-8', 08:41:44 INFO - 'LANGUAGE': 'en_US:en', 08:41:44 INFO - 'LOGNAME': 'cltbld', 08:41:44 INFO - 'MAIL': '/var/mail/cltbld', 08:41:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:44 INFO - 'MOZ_NO_REMOTE': '1', 08:41:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:44 INFO - 'NO_EM_RESTART': '1', 08:41:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:44 INFO - 'PWD': '/builds/slave/test', 08:41:44 INFO - 'SHELL': '/bin/bash', 08:41:44 INFO - 'SHLVL': '1', 08:41:44 INFO - 'TERM': 'linux', 08:41:44 INFO - 'TMOUT': '86400', 08:41:44 INFO - 'USER': 'cltbld', 08:41:44 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', 08:41:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:44 INFO - '_': '/tools/buildbot/bin/python'} 08:41:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:44 INFO - Downloading/unpacking blobuploader==1.2.4 08:41:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:46 INFO - Downloading blobuploader-1.2.4.tar.gz 08:41:46 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 08:41:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:41:46 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:41:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:46 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 08:41:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:41:46 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:41:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:41:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:41:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:41:46 INFO - Downloading docopt-0.6.1.tar.gz 08:41:46 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 08:41:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:41:46 INFO - Installing collected packages: blobuploader, requests, docopt 08:41:46 INFO - Running setup.py install for blobuploader 08:41:47 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:41:47 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:41:47 INFO - Running setup.py install for requests 08:41:47 INFO - Running setup.py install for docopt 08:41:47 INFO - Successfully installed blobuploader requests docopt 08:41:47 INFO - Cleaning up... 08:41:47 INFO - Return code: 0 08:41:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:41: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')]} 08:41:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41: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')]} 08:41:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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 0x7feaa0abec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a146c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ac59a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b54ac0>, '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 0x1b559a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b55e50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 08:41:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/config 08:41:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/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 08:41:47 INFO - Using env: {'DISPLAY': ':0', 08:41:47 INFO - 'HOME': '/home/cltbld', 08:41:47 INFO - 'LANG': 'en_US.UTF-8', 08:41:47 INFO - 'LANGUAGE': 'en_US:en', 08:41:47 INFO - 'LOGNAME': 'cltbld', 08:41:47 INFO - 'MAIL': '/var/mail/cltbld', 08:41:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:47 INFO - 'MOZ_NO_REMOTE': '1', 08:41:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:47 INFO - 'NO_EM_RESTART': '1', 08:41:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:47 INFO - 'PWD': '/builds/slave/test', 08:41:47 INFO - 'SHELL': '/bin/bash', 08:41:47 INFO - 'SHLVL': '1', 08:41:47 INFO - 'TERM': 'linux', 08:41:47 INFO - 'TMOUT': '86400', 08:41:47 INFO - 'USER': 'cltbld', 08:41:47 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', 08:41:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:47 INFO - '_': '/tools/buildbot/bin/python'} 08:41:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:41:47 INFO - Running setup.py (path:/tmp/pip-i4v2jT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:41:47 INFO - Running setup.py (path:/tmp/pip-47WI3K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:41:47 INFO - Running setup.py (path:/tmp/pip-GYO__z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:41:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:41:48 INFO - Running setup.py (path:/tmp/pip-K73l6t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:41:48 INFO - Running setup.py (path:/tmp/pip-j0Wr8Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:41:48 INFO - Running setup.py (path:/tmp/pip-ESxYHd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:41:48 INFO - Running setup.py (path:/tmp/pip-YHH7Rp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:41:48 INFO - Running setup.py (path:/tmp/pip-KoOzys-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:41:48 INFO - Running setup.py (path:/tmp/pip-BIJ__Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:41:48 INFO - Running setup.py (path:/tmp/pip-aWjPBc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:41:48 INFO - Running setup.py (path:/tmp/pip-Wf_EsI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:41:48 INFO - Running setup.py (path:/tmp/pip-xUBw_W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:41:48 INFO - Running setup.py (path:/tmp/pip-gBh_GJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:41:48 INFO - Running setup.py (path:/tmp/pip-_rLsE8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:41:48 INFO - Running setup.py (path:/tmp/pip-dTL3G9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:41:48 INFO - Running setup.py (path:/tmp/pip-O8LJtQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:41:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:41:48 INFO - Running setup.py (path:/tmp/pip-O_oPKg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:41:49 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:41:49 INFO - Running setup.py install for manifestparser 08:41:49 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:41:49 INFO - Running setup.py install for mozcrash 08:41:49 INFO - Running setup.py install for mozdebug 08:41:49 INFO - Running setup.py install for mozdevice 08:41:49 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:41:49 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:41:49 INFO - Running setup.py install for mozfile 08:41:49 INFO - Running setup.py install for mozhttpd 08:41:49 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:41:49 INFO - Running setup.py install for mozinfo 08:41:49 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:41:49 INFO - Running setup.py install for mozInstall 08:41:49 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:41:49 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:41:49 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:41:49 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:41:49 INFO - Running setup.py install for mozleak 08:41:49 INFO - Running setup.py install for mozlog 08:41:50 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:41:50 INFO - Running setup.py install for moznetwork 08:41:50 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:41:50 INFO - Running setup.py install for mozprocess 08:41:50 INFO - Running setup.py install for mozprofile 08:41:50 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:41:50 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:41:50 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:41:50 INFO - Running setup.py install for mozrunner 08:41:50 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:41:50 INFO - Running setup.py install for mozscreenshot 08:41:50 INFO - Running setup.py install for moztest 08:41:50 INFO - Running setup.py install for mozversion 08:41:50 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:41:50 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:41:50 INFO - Cleaning up... 08:41:50 INFO - Return code: 0 08:41:50 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:41:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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 0x7feaa0abec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a146c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ac59a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b54ac0>, '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 0x1b559a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b55e50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 08:41:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/config 08:41:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/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 08:41:50 INFO - Using env: {'DISPLAY': ':0', 08:41:50 INFO - 'HOME': '/home/cltbld', 08:41:50 INFO - 'LANG': 'en_US.UTF-8', 08:41:50 INFO - 'LANGUAGE': 'en_US:en', 08:41:50 INFO - 'LOGNAME': 'cltbld', 08:41:50 INFO - 'MAIL': '/var/mail/cltbld', 08:41:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:50 INFO - 'MOZ_NO_REMOTE': '1', 08:41:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:50 INFO - 'NO_EM_RESTART': '1', 08:41:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:50 INFO - 'PWD': '/builds/slave/test', 08:41:50 INFO - 'SHELL': '/bin/bash', 08:41:50 INFO - 'SHLVL': '1', 08:41:50 INFO - 'TERM': 'linux', 08:41:50 INFO - 'TMOUT': '86400', 08:41:50 INFO - 'USER': 'cltbld', 08:41:50 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', 08:41:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:50 INFO - '_': '/tools/buildbot/bin/python'} 08:41:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:41:51 INFO - Running setup.py (path:/tmp/pip-uz7lij-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:41:51 INFO - Running setup.py (path:/tmp/pip-aiXYYh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:41:51 INFO - Running setup.py (path:/tmp/pip-6yxzgw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:41:51 INFO - Running setup.py (path:/tmp/pip-3mNLhn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:41:51 INFO - Running setup.py (path:/tmp/pip-CYX7hK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:41:51 INFO - Running setup.py (path:/tmp/pip-JOeWVr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:41:51 INFO - Running setup.py (path:/tmp/pip-H_uMfW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:41:51 INFO - Running setup.py (path:/tmp/pip-cLZ2Ix-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:41:51 INFO - Running setup.py (path:/tmp/pip-_1afK2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:41:51 INFO - Running setup.py (path:/tmp/pip-jwRw5c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:41:51 INFO - Running setup.py (path:/tmp/pip-oL2wLA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:41:51 INFO - Running setup.py (path:/tmp/pip-kcEKA4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:41:51 INFO - Running setup.py (path:/tmp/pip-N_llPL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:41:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 08:41:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:41:51 INFO - Running setup.py (path:/tmp/pip-65UHpG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:41:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 08:41:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:41:52 INFO - Running setup.py (path:/tmp/pip-f_w6XE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:41:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 08:41:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:41:52 INFO - Running setup.py (path:/tmp/pip-_ZTPLH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:41:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 08:41:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:41:52 INFO - Running setup.py (path:/tmp/pip-itNTbd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:41:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 08:41:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:41:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:41:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:41:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:41:52 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:41:52 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:41: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 08:41: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 08:41: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 08:41: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 08:41: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 08:41: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 08:41:53 INFO - Downloading blessings-1.5.1.tar.gz 08:41:53 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 08:41:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:41:53 INFO - Installing collected packages: blessings 08:41:53 INFO - Running setup.py install for blessings 08:41:54 INFO - Successfully installed blessings 08:41:54 INFO - Cleaning up... 08:41:54 INFO - Return code: 0 08:41:54 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:41:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:41:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:41:54 INFO - Reading from file tmpfile_stdout 08:41:54 INFO - Current package versions: 08:41:54 INFO - argparse == 1.2.1 08:41:54 INFO - blessings == 1.5.1 08:41:54 INFO - blobuploader == 1.2.4 08:41:54 INFO - docopt == 0.6.1 08:41:54 INFO - manifestparser == 1.1 08:41:54 INFO - mozInstall == 1.12 08:41:54 INFO - mozcrash == 0.16 08:41:54 INFO - mozdebug == 0.1 08:41:54 INFO - mozdevice == 0.47 08:41:54 INFO - mozfile == 1.2 08:41:54 INFO - mozhttpd == 0.7 08:41:54 INFO - mozinfo == 0.9 08:41:54 INFO - mozleak == 0.1 08:41:54 INFO - mozlog == 3.0 08:41:54 INFO - moznetwork == 0.27 08:41:54 INFO - mozprocess == 0.22 08:41:54 INFO - mozprofile == 0.27 08:41:54 INFO - mozrunner == 6.11 08:41:54 INFO - mozscreenshot == 0.1 08:41:54 INFO - mozsystemmonitor == 0.0 08:41:54 INFO - moztest == 0.7 08:41:54 INFO - mozversion == 1.4 08:41:54 INFO - psutil == 3.1.1 08:41:54 INFO - requests == 1.2.3 08:41:54 INFO - wsgiref == 0.1.2 08:41:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:41:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:41:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:41:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:41:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:41:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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 0x7feaa0abec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a146c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ac59a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1b54ac0>, '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 0x1b559a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b55e50>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', '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', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/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 08:41:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/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/build/tests/talos 08:41:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/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 08:41:54 INFO - Using env: {'DISPLAY': ':0', 08:41:54 INFO - 'HOME': '/home/cltbld', 08:41:54 INFO - 'LANG': 'en_US.UTF-8', 08:41:54 INFO - 'LANGUAGE': 'en_US:en', 08:41:54 INFO - 'LOGNAME': 'cltbld', 08:41:54 INFO - 'MAIL': '/var/mail/cltbld', 08:41:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:41:54 INFO - 'MOZ_NO_REMOTE': '1', 08:41:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:41:54 INFO - 'NO_EM_RESTART': '1', 08:41:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:41:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:41:54 INFO - 'PWD': '/builds/slave/test', 08:41:54 INFO - 'SHELL': '/bin/bash', 08:41:54 INFO - 'SHLVL': '1', 08:41:54 INFO - 'TERM': 'linux', 08:41:54 INFO - 'TMOUT': '86400', 08:41:54 INFO - 'USER': 'cltbld', 08:41:54 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', 08:41:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:41:54 INFO - '_': '/tools/buildbot/bin/python'} 08:41:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:41:54 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:41:54 INFO - Cleaning up... 08:41:54 INFO - Return code: 0 08:41:54 INFO - Running post-action listener: _resource_record_post_action 08:41:54 INFO - Running post-action listener: _start_resource_monitoring 08:41:54 INFO - Starting resource monitoring. 08:41:54 INFO - ##### 08:41:54 INFO - ##### Running install step. 08:41:54 INFO - ##### 08:41:54 INFO - Running pre-action listener: _resource_record_pre_action 08:41:54 INFO - Running main action method: install 08:41:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:41:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:41:54 INFO - Reading from file tmpfile_stdout 08:41:54 INFO - Detecting whether we're running mozinstall >=1.0... 08:41:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:41:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:41:54 INFO - Reading from file tmpfile_stdout 08:41:54 INFO - Output received: 08:41:54 INFO - Usage: mozinstall [options] installer 08:41:54 INFO - Options: 08:41:54 INFO - -h, --help show this help message and exit 08:41:54 INFO - -d DEST, --destination=DEST 08:41:54 INFO - Directory to install application into. [default: 08:41:54 INFO - "/builds/slave/test"] 08:41:54 INFO - --app=APP Application being installed. [default: firefox] 08:41:54 INFO - mkdir: /builds/slave/test/build/application 08:41:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 08:41:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 08:42:09 INFO - Reading from file tmpfile_stdout 08:42:09 INFO - Output received: 08:42:09 INFO - /builds/slave/test/build/application/firefox/firefox 08:42:09 INFO - Running post-action listener: _resource_record_post_action 08:42:09 INFO - ##### 08:42:09 INFO - ##### Running run-tests step. 08:42:09 INFO - ##### 08:42:09 INFO - Running pre-action listener: _resource_record_pre_action 08:42:09 INFO - Running main action method: run_tests 08:42:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:42:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:42:09 INFO - Python 2.7.3 08:42:09 INFO - Return code: 0 08:42:09 INFO - grabbing minidump binary from tooltool 08:42:09 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')]} 08:42:09 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/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 0x1b54ac0>, '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 0x1b559a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1b55e50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:42:09 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 08:42:09 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 08:42:09 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:42:09 INFO - Return code: 0 08:42:09 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:42:09 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:42:09 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:42:09 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:42:09 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:42:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'B2G-Inbound-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-039', '--webServer', 'localhost'] in /builds/slave/test/build 08:42:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName B2G-Inbound-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-039 --webServer localhost 08:42:09 INFO - Using env: {'DISPLAY': ':0', 08:42:09 INFO - 'HOME': '/home/cltbld', 08:42:09 INFO - 'LANG': 'en_US.UTF-8', 08:42:09 INFO - 'LANGUAGE': 'en_US:en', 08:42:09 INFO - 'LOGNAME': 'cltbld', 08:42:09 INFO - 'MAIL': '/var/mail/cltbld', 08:42:09 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:42:09 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:42:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:42:09 INFO - 'MOZ_NO_REMOTE': '1', 08:42:09 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:42:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:42:09 INFO - 'NO_EM_RESTART': '1', 08:42:09 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:42:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:42:09 INFO - 'PWD': '/builds/slave/test', 08:42:09 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:42:09 INFO - 'SHELL': '/bin/bash', 08:42:09 INFO - 'SHLVL': '1', 08:42:09 INFO - 'TERM': 'linux', 08:42:09 INFO - 'TMOUT': '86400', 08:42:09 INFO - 'USER': 'cltbld', 08:42:09 INFO - 'XDG_SESSION_COOKIE': '6e558709db315bacd2260379000001b6-1447691731.338944-2088164858', 08:42:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:42:09 INFO - '_': '/tools/buildbot/bin/python'} 08:42:09 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'B2G-Inbound-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-039', '--webServer', 'localhost'] with output_timeout 3600 08:42:09 INFO - mozversion INFO | application_buildid: 20151116075758 08:42:09 INFO - mozversion INFO | application_changeset: 9143161fa821bce46c9d4ce47ed4882e92330656 08:42:09 INFO - mozversion INFO | application_display_name: Nightly 08:42:09 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:42:09 INFO - mozversion INFO | application_name: Firefox 08:42:09 INFO - mozversion INFO | application_remotingname: firefox 08:42:09 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/b2g-inbound 08:42:09 INFO - mozversion INFO | application_vendor: Mozilla 08:42:09 INFO - mozversion INFO | application_version: 45.0a1 08:42:09 INFO - mozversion INFO | platform_buildid: 20151116075758 08:42:09 INFO - mozversion INFO | platform_changeset: 9143161fa821bce46c9d4ce47ed4882e92330656 08:42:09 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/b2g-inbound 08:42:09 INFO - mozversion INFO | platform_version: 45.0a1 08:42:09 INFO - 2015-11-16 08:42:09,701 DEBUG : using testdate: 1447692129 08:42:09 INFO - 2015-11-16 08:42:09,701 DEBUG : actual date: 1447692129 08:42:09 INFO - 2015-11-16 08:42:09,709 INFO : starting webserver on 'localhost:38105' 08:42:09 INFO - 2015-11-16 08:42:09,710 INFO : Starting test suite talos-linux64-ix-039 08:42:09 INFO - 2015-11-16 08:42:09,710 INFO : Starting test dromaeo_css 08:42:09 INFO - 2015-11-16 08:42:09,710 DEBUG : operating with platform_type : linux_ 08:42:09 INFO - 2015-11-16 08:42:09,710 INFO : Initialising browser for dromaeo_css test... 08:42:09 INFO - 2015-11-16 08:42:09,717 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFZbo7k/profile http://localhost:38105/getInfo.html 08:42:14 INFO - 2015-11-16 08:42:14,195 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 08:42:14 INFO - 2015-11-16 08:42:14,196 DEBUG : BROWSER_OUTPUT: colorDepth:24 08:42:14 INFO - 2015-11-16 08:42:14,196 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 08:42:14 INFO - 2015-11-16 08:42:14,196 DEBUG : BROWSER_OUTPUT: __metrics 08:42:14 INFO - 2015-11-16 08:42:14,365 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:42:15 INFO - 2015-11-16 08:42:15,587 INFO : Browser initialized. 08:42:15 INFO - 2015-11-16 08:42:15,588 INFO : Running cycle 1/1 for dromaeo_css test... 08:42:15 INFO - 2015-11-16 08:42:15,588 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFZbo7k/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 08:42:27 INFO - 2015-11-16 08:42:27,515 DEBUG : BROWSER_OUTPUT: RSS: Main: 142196736 08:42:27 INFO - 2015-11-16 08:42:27,515 DEBUG : BROWSER_OUTPUT: 08:43:18 INFO - 2015-11-16 08:43:18,845 DEBUG : BROWSER_OUTPUT: 1447692198844 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] 08:45:30 INFO - 2015-11-16 08:45:30,708 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/dromaeo/cssquery-dojo.html (next: http://localhost:38105/tests/dromaeo/cssquery-ext.html) 08:45:31 INFO - 2015-11-16 08:45:31,874 DEBUG : BROWSER_OUTPUT: RSS: Main: 250445824 08:45:31 INFO - 2015-11-16 08:45:31,874 DEBUG : BROWSER_OUTPUT: 08:48:34 INFO - 2015-11-16 08:48:34,453 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/dromaeo/cssquery-ext.html (next: http://localhost:38105/tests/dromaeo/cssquery-jquery.html) 08:48:35 INFO - 2015-11-16 08:48:35,026 DEBUG : BROWSER_OUTPUT: RSS: Main: 219193344 08:48:35 INFO - 2015-11-16 08:48:35,026 DEBUG : BROWSER_OUTPUT: 08:51:37 INFO - 2015-11-16 08:51:37,154 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/dromaeo/cssquery-jquery.html (next: http://localhost:38105/tests/dromaeo/cssquery-mootools.html) 08:51:37 INFO - 2015-11-16 08:51:37,735 DEBUG : BROWSER_OUTPUT: RSS: Main: 210886656 08:51:37 INFO - 2015-11-16 08:51:37,735 DEBUG : BROWSER_OUTPUT: 08:54:39 INFO - 2015-11-16 08:54:39,641 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/dromaeo/cssquery-mootools.html (next: http://localhost:38105/tests/dromaeo/cssquery-prototype.html) 08:54:40 INFO - 2015-11-16 08:54:40,210 DEBUG : BROWSER_OUTPUT: RSS: Main: 201048064 08:54:40 INFO - 2015-11-16 08:54:40,210 DEBUG : BROWSER_OUTPUT: 08:57:42 INFO - 2015-11-16 08:57:42,852 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/dromaeo/cssquery-prototype.html (next: http://localhost:38105/tests/dromaeo/cssquery-yui.html) 08:57:43 INFO - 2015-11-16 08:57:43,437 DEBUG : BROWSER_OUTPUT: RSS: Main: 181542912 08:57:43 INFO - 2015-11-16 08:57:43,438 DEBUG : BROWSER_OUTPUT: 09:00:45 INFO - 2015-11-16 09:00:45,996 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/dromaeo/cssquery-yui.html (next: http://localhost:38105/tests/dromaeo/cssquery-dojo.html) 09:00:46 INFO - 2015-11-16 09:00:46,240 DEBUG : BROWSER_OUTPUT: RSS: Main: 253366272 09:00:46 INFO - 2015-11-16 09:00:46,240 DEBUG : BROWSER_OUTPUT: 09:00:46 INFO - 2015-11-16 09:00:46,241 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:00:46 INFO - 2015-11-16 09:00:46,241 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:00:46 INFO - 2015-11-16 09:00:46,241 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:00:46 INFO - 2015-11-16 09:00:46,242 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:00:46 INFO - 2015-11-16 09:00:46,243 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2640.603909413588;2720.986395068024;2729.6997330293675;2741.6984131745503;2752.5871119332096;4596.218642830719;4702.24764037754;4706.152892479361;4786.952130478699;4828.2274836026245;4796.640251981098;4818.08456393285;4887.144749668802;4900;4902.044101400228;4420.0496893167965;4491.30384790358;4515.412996310483;4595.241785105453;4650.372199753041;4302.569743025688;4400.647948164155;4536.9791796845775;4581.725096494204;4595.379623750801;4342.848000320006;4432.135733531963;4435.3790469334;4442.755648439334;4463.799129039168;4477.664175186841;4479.148961697267;4479.193745125876;4504.977475112636;4534.433195850519;4249.256380133495;4376.89057773555;4434;4458.57643523868;4469.128519938613;4667.8599642010795;4759.714417134983;4779.545943135397;4785.3300537924715;4817.470078291385;5181.948180518184;5186.896262074775;5190.4031036430915;5194.091034069061;5220.634555581111;4918.409790825088;5034.496550344973;5039.697618142886;5202.08963431398;5213.113770658997;4679.953200467986;4835.6131509479155;4838.782254798542;4843.951560484421;4884.633652476078;5293.179557168568;5296.25852380667;5297.973510132425;5299.761510732026;5343.919841202385;4833.540813622701;4940.061388336205;4941.48114447985;5092.28707980883;5099.082165210298;5132.897342053138;5234.110201265794;5235.869103272373;5239.47605239473;5279.577633789288;5151.9484805152215;5158.664686795346;5162.6902385856965;5165.276861239429;5202.375714914158;4892.412910450768;4998.4251811042195;5008.64939454242;5125.718085505333;5127.384713834289;3871.457995880579;3946.1121247719607;3957.08986933007;3974.3044967130636;3974.5429275633096;3511.1046683095647;3511.455724362728;3512.3150985557572;3539.876104336336;3540.7875527468436;4219.78901054946;4484.663650226246;4492.528284530077;4493.236149854467;4527.1172121436;5067.594592432597;5107.463716309734;5134.409542902614;5136.280920671109;5197.8440646780655;4452.443444569429;4469.776511174493;4472;4477.104579084131;4512.029913568598;4294.420253265832;4547.840825571089;4548.840790572314;4553.362529245908;4588.472325682523;4691.483936766953;4710.905781884411;4773.474917758975;4827.444843843003;4882.121218180761;5201.063808514504;5233.555147812479;5236.26628841418;5239.26650268955;5279.551238144647;4699.436067671902;4959.82640607577;4962.900741985068;4963.131451995959;4963.751812409438;5029.4719054498755;5044.722540260174;5085.898282034264;5188.429272779916;5210.6613070150315;5124.615653825904;5136.203888397305;5138.588912886886;5142.897142057063;5167.22491626259;4798.352222449925;4970.975145124251;4975.975120124376;4996.300517927566;5009.974950125226;4894.951050489592;4939.5554400104165;4944.431390390151;4983.601311894967;5012.649114561946;4918.2868484068895;4918.778654960463;4921.803127874845;4923.655344125877;4924.212126059957;4828.734419606955;5039.672421292605;5044.772985215601;5047.444781074006;5077.136886729191;4841.080194762983;4862.756862156949;4878.463369029333;4927.457979622167;4937.308776771183 09:00:46 INFO - 2015-11-16 09:00:46,244 DEBUG : BROWSER_OUTPUT: |1;ext.html;575.7322844877132;577.7457918515855;582.7523302596398;588.4204059001885;594.4560726934855;28891;29707.70292297079;38602.22795544091;39417.605823941754;39442.80278598603;42543.361849572284;42954.140917181634;43118.353224701656;43170.784146079226;43326;7128.821779455503;7975.840483190333;8153.184681531859;8153.8776918346275;8160.551169685665;7201.387882030033;10381.169506439466;10637.57449702011;10639.468026598677;10647.361158330486;10328.431936243504;10417.583296668125;10457.895421045807;10462.11072058872;10465.633702820403;7287.817804554876;7458.6270686466005;10319.638812641559;10424.739381515446;10437.478126093665;9845.50772461374;9961.950190249003;9971.90028099717;9978.301518893608;9986.151177149952;38108;38654.80672596619;38697.806510967544;38702.225955481015;38715;2896;3044.0106965236387;3044.6803085675906;3177.809331440121;3422.0076177908377;29385;29534.11397658074;29649.258768530744;30005.699943000727;30172.396552069054;3125.984370078158;3185.7451403887635;3187.42626327261;3218.6620404857385;3242.886498972525;233734;234551;235424;235714;235920;52269.47730522722;53557.46442535525;58785.706071470224;59284.70357648184;63989.36010639834;59286.70356648189;59315.70342148262;59326;59362;59492.405075948685;13201.07592468518;13511.527096551574;13560;13568.660783480493;13585.456581736818;9749;9757.26820488452;9760.853587196198;9767.16979056774;9778.119969202806;19430.611387772165;19892.90053549723;19974.800251997585;20044.398668039983;20103.39689809308;7079.256678048834;7151.427885769126;7255.56466612005;7276.63616819157;7317.926820731831;794.5749024271987;820.2863508747428;821.6097353756918;876.3120950054305;943.6036864516919;23933.251037375074;25899.870500647376;26059.348516286864;26444.867775660998;26550.86724566365;812.212154210415;830.6552780596106;850.8170743290223;962.4802606592361;974.016243593961;12964.546240881713;13332.400181964618;13700.24648644334;14533.92733036328;15195.164265965477;210532;213707;213746;213863;214113;43328.133437331075;43394.132117357476;43468.782656086514;43551;43561.78219108948;1206.1315852586124;1211.8303437518755;1214.059104194239;1219.9756004879853;1341.7651910915747;26139.738602613732;28180;28355.432891341647;28375.29061773472;28861.855690722252;37223.627763723096;38299.23401531898;43463.348049778644;44302.11395772002;44357.556424435345;212682;213727;214192;214436;214456;24614.261572152864;25289.367765806;28813.56779648265;29148.27129321784;29169.854150729112;37917.05207369838;38372.42441363438;38925.02687432837;39710.02899710006;40344;30024.69975300219;30315;30904.690953090183;31341.843290784313;31368.215794605316;31230.37539249157;31418.528722069645;31611.84194079015;31624;31673.524897127023;33735.97584144959;33855.66144338525;33908.83045584855;34399;34792.13019674427;28023.159305220877;29307;30900;31377.372452550364;31488.527672085394;21438.785612143678;21746.347609571738;21886.89056554707;21980.340589782332;21994 09:00:46 INFO - 2015-11-16 09:00:46,245 DEBUG : BROWSER_OUTPUT: |2;jquery.html;344.60026369411486;344.7052769881751;344.97412694047944;345.3042120127941;345.67333869493325;12498.937505312484;12829.166104203221;14854.628634284134;15068.698626027473;16625.750613740787;10969.561217551289;11251.54993800247;11260.718482037953;14560.126392416463;15071.397144114222;4060.2691515527194;4122.608352206543;4224.281872081738;4239.5548467410945;4241.257779888522;3158.8578513966927;3227.757918156136;4251.171021650779;4576.542345765413;4637.188492013884;4558.703684260512;4569.862904112882;4572.634189264867;4578.130155270488;4627.884302892421;4557.339185818055;4562.5665561771575;4596.080783843228;5936.495397891184;6166.506679465632;5763.740631671585;5857.4435428634215;5892.23400957877;5920.79277225295;5923.348431672513;18974.81025189744;19397.709034364354;19561.21755129793;20296.49258768528;20485.180592776273;1796.5957659526632;1842.2446796813376;1889.811018898113;1898.0604600722731;2048.068129001301;12884.098113132084;13140.474381024747;13152.6711832204;13269.071165018453;13479.595612131652;1718.501634525986;1801.9459416217535;1839.5401149712573;1840.9815901840943;1862.534366408398;61318.386816131715;63214.36785632131;63355.683221584055;63549.68225158891;63615.045774313425;15063.849361506464;15638.687226255639;15656.373745050298;15669.686606268038;15747.606309842116;22911.656325155134;22941.541169176522;23146.421339466648;23148.65277020846;23218.8839055807;8192;8496;8568.314534837198;8660.393772435995;8717.782055448664;7204.963975180195;7238.457115716237;7245.058142441449;7257.237990011078;7283.562986220843;7523.3981281497345;7654.770356889302;7656.540607563564;7657.731979380695;7680.270374314431;1093.923425360233;2044.2640649366217;2928.5314349703945;2993;3050.4966680497914;350.50753691064097;384.13186199189477;391.20194802602373;396.738152819138;406.9776162311101;10045.246606504541;10426.739331516621;10608.992145746142;10727.356358618508;10788.244822862482;395.83572817281083;406.3620116417256;410.9568495308009;418.49362271651034;445.7102883125929;5293.20601909709;5805.709714514257;6231.968840155861;6236.282827474808;6390.041493775971;479822;492912.53543732053;493558.9830762707;493730;498231;65942.34057659458;68256;68759;69719;72242.27757722461;472.1383475157782;480.4210925834361;480.42829033450084;481.21802071633596;482.9541193586674;10052.145567626541;10088.495575221357;10094.596216151273;10136.44249566281;10224.130948869131;30104.849475752482;32813.67186328202;33005.66994330026;34154.48768268428;34203.75064368881;36279.63720362762;39054.6094539051;39365;39855.40216896691;40615.59384406118;5686;5761.798337058183;5803.506701930383;5807.477327040587;5811.244538210006;10133;10213.540390682585;10468.162546996069;10481.947590262305;10512.737181570215;8591.87112193305;8635.611397487253;8651.567421629019;8940.73177804667;9476.47879366614;9327.81344373095;9344.532773361168;9375.390599611004;9476.952615237156;9719.17387022111;9141.131592498701;9232.676856309998;9279.907200927904;9413.952930235306;9452;5488.259085023471;5627.915581266366;5807.157962095557;6231.532635052298;6446.935530644633;9657.613695452103;9785.266105042292;9849.852252216078;9858.556364963737;10312.917143699804 09:00:46 INFO - 2015-11-16 09:00:46,245 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1173.3605185174079;1612.9112898790565;1654.1315809200169;1690.9154542272888;1699.7620333153352;6028.728707208175;6674.332566743323;6777.356151165632;6800.319968003203;6833.726650933969;6792.388685018347;6937.791866244008;6940.410065144456;6953.44372450204;6971.128608923885;2020.5150763816653;2042.8876411797346;2047.2220556188702;2047.2834507922182;2048.252387878421;2083.9687404688943;2088.6866969954553;2092.184048221195;2097.4336929029155;2108.1988844239168;2004.0380617303704;2006.9899650501727;2014.48630599197;2016.0625309231204;2016.6269240190538;1998.0808827939165;2008.6183625111255;2012.0744457549545;2013.1041686449537;2013.7382140321665;2026.5845501672122;2052.004777682823;2059.1454546363393;2059.680749483832;2060.2274147194803;5709.714514274269;5880.029795083806;6864.725410983555;6905.102336696247;6908.516403851732;4032.6773858091283;4128.422020917044;4151.958480415187;4162.4796900387455;4175.645070169039;2740.082072505713;2786.3591373983895;2832.830030198195;2843.218115018366;2871.0095017219237;900.8423525882944;901.8151278987792;916.862470629411;925.8657494663304;927.429630777074;9321.766955826091;9381.202597779196;9389.483578403117;9396.389234699722;9402.106799854002;3874.341361968472;3881.0879443330796;3924.430957511202;3929.8428062877165;3974.6621537169663;8132.430729848854;8162;8162.510249385056;8168.714095006765;8170.346372290202;4216.262154123016;4217.325227963511;4218.6835987300465;4221.78891055446;4225.492940847118;3806.7525610835205;3808.124131449782;3816.4466152407745;3818.6563209311294;3820.675242604354;3255.4465740823644;3259.918502037468;3282.1958620137743;3298.2578919742864;3304.3556506481004;1025.564135242519;1039.2125544064197;1047.8113939490966;1047.9528421221064;1053.1416895230363;905.3888625177979;983.5033308179324;1151.1423989128152;1179.2688533109356;1181.2321990705939;6483.222013358427;6498.025296205513;6512.804615861532;6515;6532.150820393414;1026.8408396698524;1034.2036631793476;1041.2450973044633;1045.5869931377215;1068.8824229334766;4729.385179926588;5149.716765577929;5225.190095535198;5226.189940559219;5241.73791310433;7193.820154496075;7925.207479252029;8089.635966381527;8105.6757729691335;8105.918940810517;7926.326262267657;7977.521348718979;7977.760667179994;7977.840443191104;7986.7603971880935;6426.807195784134;6593.076969224312;6638.7676431325635;6653.135092438049;6689.632070236184;6577.079208910661;6594.472442204708;6616.867662646817;6618.966905165444;6646.501512386687;7315.743948961761;7507.737229196952;7516.173220945801;7543.660535276035;7569.394448444222;7501.549907005598;7677.884831727641;7854.450188486751;7887.369010479033;7903.407244456574;5485.314335708036;5521.779128834802;5556.111022236423;5642.181883626933;5799.101139323411;6537.542372033912;6566.343365663395;6613;6615.768448104293;6627.50293727982;6231.40801623845;6289.874202515833;6373.904391434039;6405.167328247298;6456.160699109086;6018.608790428783;6102.755889764538;6103.206583144341;6188.412100850412;6229.034499652561;6315.652639104894;6368.617882927039;6378.52161087911;6385.7126429309865;6390.265119511316;5822.184894114912;5833.0375488044;5844.590878638454;5851.853703657443;5860.413958604276;5699.458551437607;5844.736986835517;5871.853203669943;5873.500752436091;5874.089516124836 09:00:46 INFO - 2015-11-16 09:00:46,247 DEBUG : BROWSER_OUTPUT: |4;prototype.html;284.38572683004713;292.304315728566;295.44603867747975;297.2702016549371;303.55377594935436;5399.055165346068;5411.621186516945;5474.39781624021;5477.3427188737305;5480.451954804527;5355;5366.973165134179;5376.059189641816;5376.973115134429;5377.919331210035;4191.077962848169;4192.454980852485;4192.895177620553;4193.308104162825;4196.580341965794;3989.501312335958;4055.9391609125887;4072.0837811492474;4135.627793498585;4171.541130475645;4124.711270211072;4139.068709540359;4142.357934520154;4147.937780933288;4156.231097247004;3932.9803350983348;4067.450894129314;4140.068484590973;4154.023804405962;4154.1068670235745;3524.1189702574356;3611.693006094485;3624.311380837659;3627.6916462100753;3628.7641303315463;5183.429822719498;5184.559312458446;5188.092083885305;5200.479952004807;5208.8437346879655;4739.857804265877;4771.260454629538;4771.856844294677;4772.6420518461255;4783.067301876135;5501.834944951618;5667.263255776723;5671.291088613923;5673.546116310686;5711.8000869969355;3821.216650586623;3834.7123965702685;3838.347480928249;3838.4818049563232;3838.980805095957;5901.3508514063415;6005.4895333896675;6010.338862725097;6018.6689732064715;6019.69901504923;3869.1101046759404;3871.9806400968378;3872.9225415491533;3879.2047630236298;3882;3864.381698928158;3931.488906442144;3940.625640564142;3941.231459865356;3944.9408258876138;4657.1617108920045;4670.065986802653;4670.906581868344;4675.95324046762;4679.040796636749;5692.345380281238;5703.315602127771;5717.256756621696;5719.828405147852;5725.055365864669;1374.4776984745733;1379.2896658221025;1380.3374380297514;1381.0884816021378;1384;901.8331608652289;916.2990312411011;923.607466826596;929.697848199338;933.8132373525322;5047.924281135786;5058.367704036996;5059.19052951526;5062.493750624908;5065.164247899055;5917.852053698692;5920.171176035358;5928.525717942554;5930.614510056833;5931.673757943355;5044.066847633199;5044.621653375938;5044.848654540369;5045.268436076748;5050.747462626854;3115.4392209402527;3178.1419016865316;3191.9680803192136;3197.257494665413;3202.6797320267788;5587.05020146576;5593.8321850344555;5596.748146333425;5598.58010649203;5598.692071936001;6075.756969721162;6080.14877917092;6085.117657939574;6085.300190478063;6089.330173680892;5454.727263636882;5574.358948720868;5579.218909352694;5588.580856435784;5600.523955463831;5896.675682837314;5901.0558310670085;5905.350411454822;5908.704564771659;5924.348321684525;5763.8559036024435;5782.277215348082;5786.479216870502;5787.623804452697;5800.332961709458;5577.219189313419;5582.49757521825;5592.384837667934;5593.02122128634;5596.496315331639;3841.2701586698436;3978.6419222270133;3995.780232087147;3996.320625493615;3996.3406038003404;5893.764249430146;5909.91135132982;5915.763369465173;5918.940810592011;5924.851878703067;5673.404292549223;5698.1452782083015;5701;5710.685912274865;5713.542916566747;5529.060059789926;5687.118496633028;5697.23087383198;5699.829005129853;5703.230063941315;5558.555315574664;5567.3040869891265;5598.748056337393;5610.242617246619;5615;5511.559075273888;5684.7157642118555;5761.510271626791;5764.913526297025;5778.768849245983;5441.918371224514;5565.220869078414;5571.275734154534;5616.85957851057;5649.802256920988 09:00:46 INFO - 2015-11-16 09:00:46,248 DEBUG : BROWSER_OUTPUT: |5;yui.html;656.7373050779689;734.5996431944591;779.4777499075619;789.3487872505185;801.9398545109115;11972.401379931001;12082.939585302061;12133.757324853497;12142.271463712183;12142.514299428023;11773.293602383841;11869.109816763734;11872.7625447491;11881.108916831228;11885.940570297158;610.3408319015475;616.312811215496;761.603965937712;775.806048487878;799.021199031185;793.2503783924166;795.0221227889699;800.2757504458474;800.9839803203932;801.0907619851453;827.5531213144894;834.7871292820353;842.1115722912325;843.2284459719349;843.9620217090215;636.567134348645;644.3846126948753;817.1256755271831;829.639106988462;830.6345208108413;615.2125279642065;615.722924683894;615.8214117905802;616.4821549898107;616.5714828194407;12178.878211217863;12336.814947775702;12344.382780861011;12345;12350.135490515668;11254.212205145643;11753.588624398106;11814.763704725858;12054;12151.696207594881;9458.668946586906;9589.808203835884;9656.27577931658;9736.902630973671;9973.90026099737;3199.9840000799845;3216.758743094254;3257.853396597135;3271.9182020449443;3322.634510203876;40893.18213635711;40909.38635920463;41009.38485922714;41040.179196416204;41045.384319235236;9337.953310233406;9661.758456038655;9681.70954871355;9765.755856103655;9774.51127443625;17187.226574804165;17195.742063869053;17209.655806884042;17219;17233;5723.713814309268;5856.1508581255475;5947.6431414115295;6467.838304042437;6774.8645027100165;3664.2488289900507;3666.633336666312;3666.7066634669695;3687.8340474678703;3731.645493678096;2360.6223004319227;2390.5696974544403;2392.964105538418;2393.0906255622754;2393.7606239375923;392.15881933253013;397.66000069939787;446.54006373435413;460.7051487048292;461.66298602020714;479.302614695617;487.63671065056053;600.6366148480193;640.8558074433215;649.4187702006677;7018.543794653433;7787.299143077037;7829.725959591501;7934.166912474223;8043.557604331818;478.51430797740323;531.9255304257407;577.9768809247668;595.1964847455899;599.4574909706722;3582.7133829293593;3645.6172101929446;3821.1975485147873;3883.37865941448;3925.0187453136714;46624.53375466202;50238.74880625573;50336.24495632568;52985.735071324394;53556.46443535593;45034.32448513275;45369.546304537194;45964.310535341996;46223.76888115538;47260.7636961813;42790.144197115886;42849.571504284555;43334.7833260838;43407.782961084995;43504;7929.207079292255;8309.584520774059;8337.374696897636;8384.32925365957;8591.742247732578;32262;32660.510092349108;33043.66956330502;33198.17004574905;33299.83350083234;41622.1675566493;42209.57790422056;42325;42707;44582.55417445784;10292.948535257276;10993;10999.61501347449;11135.498902549567;11300.886991129983;11707.180497365103;11906.76186476283;11962.58130965412;11969.341686207343;12260.08049396281;10525.210609204187;10533.262671612914;10746.892531074589;10868.565257389932;11165.330080195214;10969.286996345212;10970.616028438966;11033.558657653924;11243.66269011931;11597.420128993348;10801.459927003461;10924.399158046066;10932.890671093188;11066.39134847591;11141.944290278821;9535.713928582154;9721.85417218728;9824.477801604331;9874.245447804782;9990;9408.153266206074;9635.951820241135;9756.121949024622;9761.170300524534;9764.218862491125 09:00:46 INFO - 2015-11-16 09:00:46,248 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:00:46 INFO - 2015-11-16 09:00:46,248 DEBUG : BROWSER_OUTPUT: __start_cc_report 09:00:46 INFO - 2015-11-16 09:00:46,248 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,965 09:00:46 INFO - 2015-11-16 09:00:46,248 DEBUG : BROWSER_OUTPUT: __end_cc_report 09:00:46 INFO - 2015-11-16 09:00:46,248 DEBUG : BROWSER_OUTPUT: __startTimestamp1447693246240__endTimestamp 09:00:46 INFO - 2015-11-16 09:00:46,248 DEBUG : BROWSER_OUTPUT: 09:00:46 INFO - 2015-11-16 09:00:46,248 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:00:46 INFO - 2015-11-16 09:00:46,248 DEBUG : BROWSER_OUTPUT: Number of tests: 6 09:00:46 INFO - 2015-11-16 09:00:46,249 DEBUG : BROWSER_OUTPUT: 09:00:46 INFO - 2015-11-16 09:00:46,249 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4731.12 Median:4882.12 stddev:527.29 (10.8%) stddev-sans-first:502.75 09:00:46 INFO - 2015-11-16 09:00:46,249 DEBUG : BROWSER_OUTPUT: Values: 2640.6 2721.0 2729.7 2741.7 2752.6 4596.2 4702.2 4706.2 4787.0 4828.2 4796.6 4818.1 4887.1 4900.0 4902.0 4420.0 4491.3 4515.4 4595.2 4650.4 4302.6 4400.6 4537.0 4581.7 4595.4 4342.8 4432.1 4435.4 4442.8 4463.8 4477.7 4479.1 4479.2 4505.0 4534.4 4249.3 4376.9 4434.0 4458.6 4469.1 4667.9 4759.7 4779.5 4785.3 4817.5 5181.9 5186.9 5190.4 5194.1 5220.6 4918.4 5034.5 5039.7 5202.1 5213.1 4680.0 4835.6 4838.8 4844.0 4884.6 5293.2 5296.3 5298.0 5299.8 5343.9 4833.5 4940.1 4941.5 5092.3 5099.1 5132.9 5234.1 5235.9 5239.5 5279.6 5151.9 5158.7 5162.7 5165.3 5202.4 4892.4 4998.4 5008.6 5125.7 5127.4 3871.5 3946.1 3957.1 3974.3 3974.5 3511.1 3511.5 3512.3 3539.9 3540.8 4219.8 4484.7 4492.5 4493.2 4527.1 5067.6 5107.5 5134.4 5136.3 5197.8 4452.4 4469.8 4472.0 4477.1 4512.0 4294.4 4547.8 4548.8 4553.4 4588.5 4691.5 4710.9 4773.5 4827.4 4882.1 5201.1 5233.6 5236.3 5239.3 5279.6 4699.4 4959.8 4962.9 4963.1 4963.8 5029.5 5044.7 5085.9 5188.4 5210.7 5124.6 5136.2 5138.6 5142.9 5167.2 4798.4 4971.0 4976.0 4996.3 5010.0 4895.0 4939.6 4944.4 4983.6 5012.6 4918.3 4918.8 4921.8 4923.7 4924.2 4828.7 5039.7 5044.8 5047.4 5077.1 4841.1 4862.8 4878.5 4927.5 4937.3 09:00:46 INFO - 2015-11-16 09:00:46,249 DEBUG : BROWSER_OUTPUT: 09:00:46 INFO - 2015-11-16 09:00:46,249 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:38913.25 Median:31617.92 stddev:57301.17 (181.2%) stddev-sans-first:57389.61 09:00:46 INFO - 2015-11-16 09:00:46,250 DEBUG : BROWSER_OUTPUT: Values: 575.7 577.7 582.8 588.4 594.5 28891.0 29707.7 38602.2 39417.6 39442.8 42543.4 42954.1 43118.4 43170.8 43326.0 7128.8 7975.8 8153.2 8153.9 8160.6 7201.4 10381.2 10637.6 10639.5 10647.4 10328.4 10417.6 10457.9 10462.1 10465.6 7287.8 7458.6 10319.6 10424.7 10437.5 9845.5 9962.0 9971.9 9978.3 9986.2 38108.0 38654.8 38697.8 38702.2 38715.0 2896.0 3044.0 3044.7 3177.8 3422.0 29385.0 29534.1 29649.3 30005.7 30172.4 3126.0 3185.7 3187.4 3218.7 3242.9 233734.0 234551.0 235424.0 235714.0 235920.0 52269.5 53557.5 58785.7 59284.7 63989.4 59286.7 59315.7 59326.0 59362.0 59492.4 13201.1 13511.5 13560.0 13568.7 13585.5 9749.0 9757.3 9760.9 9767.2 9778.1 19430.6 19892.9 19974.8 20044.4 20103.4 7079.3 7151.4 7255.6 7276.6 7317.9 794.6 820.3 821.6 876.3 943.6 23933.3 25899.9 26059.3 26444.9 26550.9 812.2 830.7 850.8 962.5 974.0 12964.5 13332.4 13700.2 14533.9 15195.2 210532.0 213707.0 213746.0 213863.0 214113.0 43328.1 43394.1 43468.8 43551.0 43561.8 1206.1 1211.8 1214.1 1220.0 1341.8 26139.7 28180.0 28355.4 28375.3 28861.9 37223.6 38299.2 43463.3 44302.1 44357.6 212682.0 213727.0 214192.0 214436.0 214456.0 24614.3 25289.4 28813.6 29148.3 29169.9 37917.1 38372.4 38925.0 39710.0 40344.0 30024.7 30315.0 30904.7 31341.8 31368.2 31230.4 31418.5 31611.8 31624.0 31673.5 33736.0 33855.7 33908.8 34399.0 34792.1 28023.2 29307.0 30900.0 31377.4 31488.5 21438.8 21746.3 21886.9 21980.3 21994.0 09:00:46 INFO - 2015-11-16 09:00:46,250 DEBUG : BROWSER_OUTPUT: 09:00:46 INFO - 2015-11-16 09:00:46,250 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:25978.04 Median:4240.41 stddev:80433.05 (1896.8%) stddev-sans-first:80635.65 09:00:46 INFO - 2015-11-16 09:00:46,250 DEBUG : BROWSER_OUTPUT: Values: 344.6 344.7 345.0 345.3 345.7 12498.9 12829.2 14854.6 15068.7 16625.8 10969.6 11251.5 11260.7 14560.1 15071.4 4060.3 4122.6 4224.3 4239.6 4241.3 3158.9 3227.8 4251.2 4576.5 4637.2 4558.7 4569.9 4572.6 4578.1 4627.9 4557.3 4562.6 4596.1 5936.5 6166.5 5763.7 5857.4 5892.2 5920.8 5923.3 18974.8 19397.7 19561.2 20296.5 20485.2 1796.6 1842.2 1889.8 1898.1 2048.1 12884.1 13140.5 13152.7 13269.1 13479.6 1718.5 1801.9 1839.5 1841.0 1862.5 61318.4 63214.4 63355.7 63549.7 63615.0 15063.8 15638.7 15656.4 15669.7 15747.6 22911.7 22941.5 23146.4 23148.7 23218.9 8192.0 8496.0 8568.3 8660.4 8717.8 7205.0 7238.5 7245.1 7257.2 7283.6 7523.4 7654.8 7656.5 7657.7 7680.3 1093.9 2044.3 2928.5 2993.0 3050.5 350.5 384.1 391.2 396.7 407.0 10045.2 10426.7 10609.0 10727.4 10788.2 395.8 406.4 411.0 418.5 445.7 5293.2 5805.7 6232.0 6236.3 6390.0 479822.0 492912.5 493559.0 493730.0 498231.0 65942.3 68256.0 68759.0 69719.0 72242.3 472.1 480.4 480.4 481.2 483.0 10052.1 10088.5 10094.6 10136.4 10224.1 30104.8 32813.7 33005.7 34154.5 34203.8 36279.6 39054.6 39365.0 39855.4 40615.6 5686.0 5761.8 5803.5 5807.5 5811.2 10133.0 10213.5 10468.2 10481.9 10512.7 8591.9 8635.6 8651.6 8940.7 9476.5 9327.8 9344.5 9375.4 9477.0 9719.2 9141.1 9232.7 9279.9 9414.0 9452.0 5488.3 5627.9 5807.2 6231.5 6446.9 9657.6 9785.3 9849.9 9858.6 10312.9 09:00:46 INFO - 2015-11-16 09:00:46,250 DEBUG : BROWSER_OUTPUT: 09:00:46 INFO - 2015-11-16 09:00:46,250 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4839.48 Median:5866.13 stddev:2454.25 (41.8%) stddev-sans-first:2445.66 09:00:46 INFO - 2015-11-16 09:00:46,251 DEBUG : BROWSER_OUTPUT: Values: 1173.4 1612.9 1654.1 1690.9 1699.8 6028.7 6674.3 6777.4 6800.3 6833.7 6792.4 6937.8 6940.4 6953.4 6971.1 2020.5 2042.9 2047.2 2047.3 2048.3 2084.0 2088.7 2092.2 2097.4 2108.2 2004.0 2007.0 2014.5 2016.1 2016.6 1998.1 2008.6 2012.1 2013.1 2013.7 2026.6 2052.0 2059.1 2059.7 2060.2 5709.7 5880.0 6864.7 6905.1 6908.5 4032.7 4128.4 4152.0 4162.5 4175.6 2740.1 2786.4 2832.8 2843.2 2871.0 900.8 901.8 916.9 925.9 927.4 9321.8 9381.2 9389.5 9396.4 9402.1 3874.3 3881.1 3924.4 3929.8 3974.7 8132.4 8162.0 8162.5 8168.7 8170.3 4216.3 4217.3 4218.7 4221.8 4225.5 3806.8 3808.1 3816.4 3818.7 3820.7 3255.4 3259.9 3282.2 3298.3 3304.4 1025.6 1039.2 1047.8 1048.0 1053.1 905.4 983.5 1151.1 1179.3 1181.2 6483.2 6498.0 6512.8 6515.0 6532.2 1026.8 1034.2 1041.2 1045.6 1068.9 4729.4 5149.7 5225.2 5226.2 5241.7 7193.8 7925.2 8089.6 8105.7 8105.9 7926.3 7977.5 7977.8 7977.8 7986.8 6426.8 6593.1 6638.8 6653.1 6689.6 6577.1 6594.5 6616.9 6619.0 6646.5 7315.7 7507.7 7516.2 7543.7 7569.4 7501.5 7677.9 7854.5 7887.4 7903.4 5485.3 5521.8 5556.1 5642.2 5799.1 6537.5 6566.3 6613.0 6615.8 6627.5 6231.4 6289.9 6373.9 6405.2 6456.2 6018.6 6102.8 6103.2 6188.4 6229.0 6315.7 6368.6 6378.5 6385.7 6390.3 5822.2 5833.0 5844.6 5851.9 5860.4 5699.5 5844.7 5871.9 5873.5 5874.1 09:00:46 INFO - 2015-11-16 09:00:46,251 DEBUG : BROWSER_OUTPUT: 09:00:46 INFO - 2015-11-16 09:00:46,251 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4693.39 Median:5405.34 stddev:1414.13 (26.2%) stddev-sans-first:1378.83 09:00:46 INFO - 2015-11-16 09:00:46,252 DEBUG : BROWSER_OUTPUT: Values: 284.4 292.3 295.4 297.3 303.6 5399.1 5411.6 5474.4 5477.3 5480.5 5355.0 5367.0 5376.1 5377.0 5377.9 4191.1 4192.5 4192.9 4193.3 4196.6 3989.5 4055.9 4072.1 4135.6 4171.5 4124.7 4139.1 4142.4 4147.9 4156.2 3933.0 4067.5 4140.1 4154.0 4154.1 3524.1 3611.7 3624.3 3627.7 3628.8 5183.4 5184.6 5188.1 5200.5 5208.8 4739.9 4771.3 4771.9 4772.6 4783.1 5501.8 5667.3 5671.3 5673.5 5711.8 3821.2 3834.7 3838.3 3838.5 3839.0 5901.4 6005.5 6010.3 6018.7 6019.7 3869.1 3872.0 3872.9 3879.2 3882.0 3864.4 3931.5 3940.6 3941.2 3944.9 4657.2 4670.1 4670.9 4676.0 4679.0 5692.3 5703.3 5717.3 5719.8 5725.1 1374.5 1379.3 1380.3 1381.1 1384.0 901.8 916.3 923.6 929.7 933.8 5047.9 5058.4 5059.2 5062.5 5065.2 5917.9 5920.2 5928.5 5930.6 5931.7 5044.1 5044.6 5044.8 5045.3 5050.7 3115.4 3178.1 3192.0 3197.3 3202.7 5587.1 5593.8 5596.7 5598.6 5598.7 6075.8 6080.1 6085.1 6085.3 6089.3 5454.7 5574.4 5579.2 5588.6 5600.5 5896.7 5901.1 5905.4 5908.7 5924.3 5763.9 5782.3 5786.5 5787.6 5800.3 5577.2 5582.5 5592.4 5593.0 5596.5 3841.3 3978.6 3995.8 3996.3 3996.3 5893.8 5909.9 5915.8 5918.9 5924.9 5673.4 5698.1 5701.0 5710.7 5713.5 5529.1 5687.1 5697.2 5699.8 5703.2 5558.6 5567.3 5598.7 5610.2 5615.0 5511.6 5684.7 5761.5 5764.9 5778.8 5441.9 5565.2 5571.3 5616.9 5649.8 09:00:46 INFO - 2015-11-16 09:00:46,252 DEBUG : BROWSER_OUTPUT: 09:00:46 INFO - 2015-11-16 09:00:46,252 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12712.15 Median:44043.28 stddev:14393.16 (32.7%) stddev-sans-first:14405.06 09:00:46 INFO - 2015-11-16 09:00:46,252 DEBUG : BROWSER_OUTPUT: Values: 656.7 734.6 779.5 789.3 801.9 11972.4 12082.9 12133.8 12142.3 12142.5 11773.3 11869.1 11872.8 11881.1 11885.9 610.3 616.3 761.6 775.8 799.0 793.3 795.0 800.3 801.0 801.1 827.6 834.8 842.1 843.2 844.0 636.6 644.4 817.1 829.6 830.6 615.2 615.7 615.8 616.5 616.6 12178.9 12336.8 12344.4 12345.0 12350.1 11254.2 11753.6 11814.8 12054.0 12151.7 9458.7 9589.8 9656.3 9736.9 9973.9 3200.0 3216.8 3257.9 3271.9 3322.6 40893.2 40909.4 41009.4 41040.2 41045.4 9338.0 9661.8 9681.7 9765.8 9774.5 17187.2 17195.7 17209.7 17219.0 17233.0 5723.7 5856.2 5947.6 6467.8 6774.9 3664.2 3666.6 3666.7 3687.8 3731.6 2360.6 2390.6 2393.0 2393.1 2393.8 392.2 397.7 446.5 460.7 461.7 479.3 487.6 600.6 640.9 649.4 7018.5 7787.3 7829.7 7934.2 8043.6 478.5 531.9 578.0 595.2 599.5 3582.7 3645.6 3821.2 3883.4 3925.0 46624.5 50238.7 50336.2 52985.7 53556.5 45034.3 45369.5 45964.3 46223.8 47260.8 42790.1 42849.6 43334.8 43407.8 43504.0 7929.2 8309.6 8337.4 8384.3 8591.7 32262.0 32660.5 33043.7 33198.2 33299.8 41622.2 42209.6 42325.0 42707.0 44582.6 10292.9 10993.0 10999.6 11135.5 11300.9 11707.2 11906.8 11962.6 11969.3 12260.1 10525.2 10533.3 10746.9 10868.6 11165.3 10969.3 10970.6 11033.6 11243.7 11597.4 10801.5 10924.4 10932.9 11066.4 11141.9 9535.7 9721.9 9824.5 9874.2 9990.0 9408.2 9636.0 9756.1 9761.2 9764.2 09:00:46 INFO - 2015-11-16 09:00:46,252 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:00:46 INFO - 2015-11-16 09:00:46,252 DEBUG : BROWSER_OUTPUT: 09:00:46 INFO - 2015-11-16 09:00:46,940 INFO : Browser exited with error code: 0 09:00:46 INFO - 2015-11-16 09:00:46,961 INFO : Completed test dromaeo_css (00:18:37) 09:00:46 INFO - 2015-11-16 09:00:46,961 INFO : Starting test kraken 09:00:46 INFO - 2015-11-16 09:00:46,961 DEBUG : operating with platform_type : linux_ 09:00:46 INFO - 2015-11-16 09:00:46,961 INFO : Initialising browser for kraken test... 09:00:46 INFO - 2015-11-16 09:00:46,967 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpShgWjQ/profile http://localhost:38105/getInfo.html 09:00:50 INFO - 2015-11-16 09:00:50,933 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 09:00:50 INFO - 2015-11-16 09:00:50,933 DEBUG : BROWSER_OUTPUT: colorDepth:24 09:00:50 INFO - 2015-11-16 09:00:50,933 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 09:00:50 INFO - 2015-11-16 09:00:50,933 DEBUG : BROWSER_OUTPUT: __metrics 09:00:51 INFO - 2015-11-16 09:00:51,078 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:00:52 INFO - 2015-11-16 09:00:52,286 INFO : Browser initialized. 09:00:52 INFO - 2015-11-16 09:00:52,287 INFO : Running cycle 1/1 for kraken test... 09:00:52 INFO - 2015-11-16 09:00:52,287 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpShgWjQ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 09:01:04 INFO - 2015-11-16 09:01:04,227 DEBUG : BROWSER_OUTPUT: RSS: Main: 141766656 09:01:04 INFO - 2015-11-16 09:01:04,227 DEBUG : BROWSER_OUTPUT: 09:01:06 INFO - 2015-11-16 09:01:06,822 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:38105/tests/kraken/driver.html?testName=audio-beat-detection) 09:01:07 INFO - 2015-11-16 09:01:07,404 DEBUG : BROWSER_OUTPUT: RSS: Main: 180961280 09:01:07 INFO - 2015-11-16 09:01:07,404 DEBUG : BROWSER_OUTPUT: 09:01:10 INFO - 2015-11-16 09:01:10,141 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:38105/tests/kraken/driver.html?testName=audio-dft) 09:01:10 INFO - 2015-11-16 09:01:10,722 DEBUG : BROWSER_OUTPUT: RSS: Main: 168067072 09:01:10 INFO - 2015-11-16 09:01:10,723 DEBUG : BROWSER_OUTPUT: 09:01:13 INFO - 2015-11-16 09:01:13,714 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:38105/tests/kraken/driver.html?testName=audio-fft) 09:01:14 INFO - 2015-11-16 09:01:14,280 DEBUG : BROWSER_OUTPUT: RSS: Main: 150630400 09:01:14 INFO - 2015-11-16 09:01:14,280 DEBUG : BROWSER_OUTPUT: 09:01:16 INFO - 2015-11-16 09:01:16,297 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:38105/tests/kraken/driver.html?testName=audio-oscillator) 09:01:16 INFO - 2015-11-16 09:01:16,870 DEBUG : BROWSER_OUTPUT: RSS: Main: 154836992 09:01:16 INFO - 2015-11-16 09:01:16,870 DEBUG : BROWSER_OUTPUT: 09:01:19 INFO - 2015-11-16 09:01:19,104 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:38105/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:01:19 INFO - 2015-11-16 09:01:19,670 DEBUG : BROWSER_OUTPUT: RSS: Main: 156233728 09:01:19 INFO - 2015-11-16 09:01:19,670 DEBUG : BROWSER_OUTPUT: 09:01:22 INFO - 2015-11-16 09:01:22,661 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:38105/tests/kraken/driver.html?testName=imaging-darkroom) 09:01:23 INFO - 2015-11-16 09:01:23,233 DEBUG : BROWSER_OUTPUT: RSS: Main: 156192768 09:01:23 INFO - 2015-11-16 09:01:23,233 DEBUG : BROWSER_OUTPUT: 09:01:26 INFO - 2015-11-16 09:01:26,695 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:38105/tests/kraken/driver.html?testName=imaging-desaturate) 09:01:27 INFO - 2015-11-16 09:01:27,264 DEBUG : BROWSER_OUTPUT: RSS: Main: 157511680 09:01:27 INFO - 2015-11-16 09:01:27,265 DEBUG : BROWSER_OUTPUT: 09:01:30 INFO - 2015-11-16 09:01:30,095 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:38105/tests/kraken/driver.html?testName=json-parse-financial) 09:01:30 INFO - 2015-11-16 09:01:30,676 DEBUG : BROWSER_OUTPUT: RSS: Main: 156958720 09:01:30 INFO - 2015-11-16 09:01:30,676 DEBUG : BROWSER_OUTPUT: 09:01:32 INFO - 2015-11-16 09:01:32,425 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:38105/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:01:32 INFO - 2015-11-16 09:01:32,990 DEBUG : BROWSER_OUTPUT: RSS: Main: 168398848 09:01:32 INFO - 2015-11-16 09:01:32,991 DEBUG : BROWSER_OUTPUT: 09:01:34 INFO - 2015-11-16 09:01:34,861 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:38105/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:01:35 INFO - 2015-11-16 09:01:35,463 DEBUG : BROWSER_OUTPUT: RSS: Main: 165621760 09:01:35 INFO - 2015-11-16 09:01:35,463 DEBUG : BROWSER_OUTPUT: 09:01:37 INFO - 2015-11-16 09:01:37,596 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:38105/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:01:38 INFO - 2015-11-16 09:01:38,177 DEBUG : BROWSER_OUTPUT: RSS: Main: 170979328 09:01:38 INFO - 2015-11-16 09:01:38,177 DEBUG : BROWSER_OUTPUT: 09:01:40 INFO - 2015-11-16 09:01:40,700 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:38105/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:01:41 INFO - 2015-11-16 09:01:41,293 DEBUG : BROWSER_OUTPUT: RSS: Main: 178905088 09:01:41 INFO - 2015-11-16 09:01:41,293 DEBUG : BROWSER_OUTPUT: 09:01:43 INFO - 2015-11-16 09:01:43,989 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:38105/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:01:44 INFO - 2015-11-16 09:01:44,571 DEBUG : BROWSER_OUTPUT: RSS: Main: 176852992 09:01:44 INFO - 2015-11-16 09:01:44,571 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,320 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:38105/tests/kraken/driver.html?testName=ai-astar) 09:01:46 INFO - 2015-11-16 09:01:46,566 DEBUG : BROWSER_OUTPUT: RSS: Main: 236748800 09:01:46 INFO - 2015-11-16 09:01:46,566 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,567 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:01:46 INFO - 2015-11-16 09:01:46,568 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:01:46 INFO - 2015-11-16 09:01:46,568 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:01:46 INFO - 2015-11-16 09:01:46,568 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:01:46 INFO - 2015-11-16 09:01:46,568 DEBUG : BROWSER_OUTPUT: |0;ai-astar;109;113;106;111;113;113;102;110;115;111 09:01:46 INFO - 2015-11-16 09:01:46,569 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;157;132;151;175;134;156;154;132;166;138 09:01:46 INFO - 2015-11-16 09:01:46,569 DEBUG : BROWSER_OUTPUT: |2;audio-dft;162;161;160;161;161;160;165;160;162;161 09:01:46 INFO - 2015-11-16 09:01:46,569 DEBUG : BROWSER_OUTPUT: |3;audio-fft;73;73;84;90;73;73;72;122;89;74 09:01:46 INFO - 2015-11-16 09:01:46,570 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;92;91;123;92;92;90;141;92;92;125 09:01:46 INFO - 2015-11-16 09:01:46,570 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;108;109;109;109;109;109;109;109;109;109 09:01:46 INFO - 2015-11-16 09:01:46,570 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;148;148;147;148;148;148;147;147;147;147 09:01:46 INFO - 2015-11-16 09:01:46,570 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;95;96;95;95;95;95;95;95;95 09:01:46 INFO - 2015-11-16 09:01:46,571 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;68;70;69;69;69;70;69;77;67;68 09:01:46 INFO - 2015-11-16 09:01:46,571 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;69;68;68;69;69;69;68;69;69;68 09:01:46 INFO - 2015-11-16 09:01:46,571 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;81;83;86;84;84;86;83;82;84;83 09:01:46 INFO - 2015-11-16 09:01:46,572 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;118;126;118;122;125;130;119;120;140;121 09:01:46 INFO - 2015-11-16 09:01:46,572 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;157;143;161;169;151;142;161;149;150;143 09:01:46 INFO - 2015-11-16 09:01:46,572 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;71;69;71;70;69;68;68;69;68;70 09:01:46 INFO - 2015-11-16 09:01:46,572 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:01:46 INFO - 2015-11-16 09:01:46,573 DEBUG : BROWSER_OUTPUT: __start_cc_report 09:01:46 INFO - 2015-11-16 09:01:46,573 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,991 09:01:46 INFO - 2015-11-16 09:01:46,573 DEBUG : BROWSER_OUTPUT: __end_cc_report 09:01:46 INFO - 2015-11-16 09:01:46,573 DEBUG : BROWSER_OUTPUT: __startTimestamp1447693306567__endTimestamp 09:01:46 INFO - 2015-11-16 09:01:46,573 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,577 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:01:46 INFO - 2015-11-16 09:01:46,577 DEBUG : BROWSER_OUTPUT: Number of tests: 14 09:01:46 INFO - 2015-11-16 09:01:46,578 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,578 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:110.30 Median:112.00 stddev:3.86 (3.4%) stddev-sans-first:4.07 09:01:46 INFO - 2015-11-16 09:01:46,578 DEBUG : BROWSER_OUTPUT: Values: 109.0 113.0 106.0 111.0 113.0 113.0 102.0 110.0 115.0 111.0 09:01:46 INFO - 2015-11-16 09:01:46,578 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,579 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:149.50 Median:155.00 stddev:15.01 (9.7%) stddev-sans-first:15.68 09:01:46 INFO - 2015-11-16 09:01:46,579 DEBUG : BROWSER_OUTPUT: Values: 157.0 132.0 151.0 175.0 134.0 156.0 154.0 132.0 166.0 138.0 09:01:46 INFO - 2015-11-16 09:01:46,579 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,579 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.30 Median:161.00 stddev:1.49 (0.9%) stddev-sans-first:1.56 09:01:46 INFO - 2015-11-16 09:01:46,579 DEBUG : BROWSER_OUTPUT: Values: 162.0 161.0 160.0 161.0 161.0 160.0 165.0 160.0 162.0 161.0 09:01:46 INFO - 2015-11-16 09:01:46,580 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,580 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:82.30 Median:73.50 stddev:15.65 (21.3%) stddev-sans-first:16.23 09:01:46 INFO - 2015-11-16 09:01:46,580 DEBUG : BROWSER_OUTPUT: Values: 73.0 73.0 84.0 90.0 73.0 73.0 72.0 122.0 89.0 74.0 09:01:46 INFO - 2015-11-16 09:01:46,580 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,580 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:103.00 Median:92.00 stddev:18.99 (20.6%) stddev-sans-first:19.72 09:01:46 INFO - 2015-11-16 09:01:46,580 DEBUG : BROWSER_OUTPUT: Values: 92.0 91.0 123.0 92.0 92.0 90.0 141.0 92.0 92.0 125.0 09:01:46 INFO - 2015-11-16 09:01:46,580 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,580 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:108.90 Median:109.00 stddev:0.32 (0.3%) stddev-sans-first:0.00 09:01:46 INFO - 2015-11-16 09:01:46,581 DEBUG : BROWSER_OUTPUT: Values: 108.0 109.0 109.0 109.0 109.0 109.0 109.0 109.0 109.0 109.0 09:01:46 INFO - 2015-11-16 09:01:46,581 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,581 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:147.50 Median:148.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 09:01:46 INFO - 2015-11-16 09:01:46,581 DEBUG : BROWSER_OUTPUT: Values: 148.0 148.0 147.0 148.0 148.0 148.0 147.0 147.0 147.0 147.0 09:01:46 INFO - 2015-11-16 09:01:46,581 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,581 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 09:01:46 INFO - 2015-11-16 09:01:46,581 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 96.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 09:01:46 INFO - 2015-11-16 09:01:46,581 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,581 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:69.60 Median:69.00 stddev:2.76 (4.0%) stddev-sans-first:2.86 09:01:46 INFO - 2015-11-16 09:01:46,582 DEBUG : BROWSER_OUTPUT: Values: 68.0 70.0 69.0 69.0 69.0 70.0 69.0 77.0 67.0 68.0 09:01:46 INFO - 2015-11-16 09:01:46,582 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,582 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.60 Median:69.00 stddev:0.52 (0.7%) stddev-sans-first:0.53 09:01:46 INFO - 2015-11-16 09:01:46,582 DEBUG : BROWSER_OUTPUT: Values: 69.0 68.0 68.0 69.0 69.0 69.0 68.0 69.0 69.0 68.0 09:01:46 INFO - 2015-11-16 09:01:46,582 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,582 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:83.60 Median:84.00 stddev:1.58 (1.9%) stddev-sans-first:1.36 09:01:46 INFO - 2015-11-16 09:01:46,582 DEBUG : BROWSER_OUTPUT: Values: 81.0 83.0 86.0 84.0 84.0 86.0 83.0 82.0 84.0 83.0 09:01:46 INFO - 2015-11-16 09:01:46,582 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,582 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:123.90 Median:123.50 stddev:6.85 (5.6%) stddev-sans-first:6.93 09:01:46 INFO - 2015-11-16 09:01:46,583 DEBUG : BROWSER_OUTPUT: Values: 118.0 126.0 118.0 122.0 125.0 130.0 119.0 120.0 140.0 121.0 09:01:46 INFO - 2015-11-16 09:01:46,583 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,583 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:152.60 Median:154.00 stddev:9.12 (5.9%) stddev-sans-first:9.53 09:01:46 INFO - 2015-11-16 09:01:46,583 DEBUG : BROWSER_OUTPUT: Values: 157.0 143.0 161.0 169.0 151.0 142.0 161.0 149.0 150.0 143.0 09:01:46 INFO - 2015-11-16 09:01:46,583 DEBUG : BROWSER_OUTPUT: 09:01:46 INFO - 2015-11-16 09:01:46,583 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.30 Median:69.50 stddev:1.16 (1.7%) stddev-sans-first:1.05 09:01:46 INFO - 2015-11-16 09:01:46,583 DEBUG : BROWSER_OUTPUT: Values: 71.0 69.0 71.0 70.0 69.0 68.0 68.0 69.0 68.0 70.0 09:01:46 INFO - 2015-11-16 09:01:46,583 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:01:46 INFO - 2015-11-16 09:01:46,583 DEBUG : BROWSER_OUTPUT: 09:01:47 INFO - 2015-11-16 09:01:47,552 INFO : Browser exited with error code: 0 09:01:47 INFO - 2015-11-16 09:01:47,602 INFO : Completed test kraken (00:01:00) 09:01:47 INFO - 2015-11-16 09:01:47,602 INFO : Starting test v8_7 09:01:47 INFO - 2015-11-16 09:01:47,602 DEBUG : operating with platform_type : linux_ 09:01:47 INFO - 2015-11-16 09:01:47,602 INFO : Initialising browser for v8_7 test... 09:01:47 INFO - 2015-11-16 09:01:47,608 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpddPvnh/profile http://localhost:38105/getInfo.html 09:01:51 INFO - 2015-11-16 09:01:51,587 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 09:01:51 INFO - 2015-11-16 09:01:51,588 DEBUG : BROWSER_OUTPUT: colorDepth:24 09:01:51 INFO - 2015-11-16 09:01:51,588 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 09:01:51 INFO - 2015-11-16 09:01:51,588 DEBUG : BROWSER_OUTPUT: __metrics 09:01:51 INFO - 2015-11-16 09:01:51,745 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:01:52 INFO - 2015-11-16 09:01:52,978 INFO : Browser initialized. 09:01:52 INFO - 2015-11-16 09:01:52,978 INFO : Running cycle 1/1 for v8_7 test... 09:01:52 INFO - 2015-11-16 09:01:52,978 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpddPvnh/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 09:02:04 INFO - 2015-11-16 09:02:04,856 DEBUG : BROWSER_OUTPUT: RSS: Main: 141119488 09:02:04 INFO - 2015-11-16 09:02:04,856 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,254 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38105/tests/v8_7/run.html (next: http://localhost:38105/tests/v8_7/run.html) 09:02:26 INFO - 2015-11-16 09:02:26,512 DEBUG : BROWSER_OUTPUT: RSS: Main: 441647104 09:02:26 INFO - 2015-11-16 09:02:26,512 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,512 DEBUG : BROWSER_OUTPUT: __start_tp_report 09:02:26 INFO - 2015-11-16 09:02:26,512 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 09:02:26 INFO - 2015-11-16 09:02:26,513 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 09:02:26 INFO - 2015-11-16 09:02:26,513 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 09:02:26 INFO - 2015-11-16 09:02:26,513 DEBUG : BROWSER_OUTPUT: |0;Richards;164.09583196586806 09:02:26 INFO - 2015-11-16 09:02:26,513 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;191.5341888527102 09:02:26 INFO - 2015-11-16 09:02:26,513 DEBUG : BROWSER_OUTPUT: |2;Encrypt;279.3296089385475 09:02:26 INFO - 2015-11-16 09:02:26,513 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5035.175879396985 09:02:26 INFO - 2015-11-16 09:02:26,513 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1988.0715705765408 09:02:26 INFO - 2015-11-16 09:02:26,514 DEBUG : BROWSER_OUTPUT: |5;Earley;817.8104575163399 09:02:26 INFO - 2015-11-16 09:02:26,514 DEBUG : BROWSER_OUTPUT: |6;Boyer;11940.47619047619 09:02:26 INFO - 2015-11-16 09:02:26,514 DEBUG : BROWSER_OUTPUT: |7;RegExp;26315.78947368421 09:02:26 INFO - 2015-11-16 09:02:26,514 DEBUG : BROWSER_OUTPUT: |8;Splay;620.3473945409429 09:02:26 INFO - 2015-11-16 09:02:26,514 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4835.748792270531 09:02:26 INFO - 2015-11-16 09:02:26,514 DEBUG : BROWSER_OUTPUT: __end_tp_report 09:02:26 INFO - 2015-11-16 09:02:26,514 DEBUG : BROWSER_OUTPUT: __startTimestamp1447693346505__endTimestamp 09:02:26 INFO - 2015-11-16 09:02:26,515 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,515 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 09:02:26 INFO - 2015-11-16 09:02:26,515 DEBUG : BROWSER_OUTPUT: Number of tests: 10 09:02:26 INFO - 2015-11-16 09:02:26,515 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,515 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:164.10 Median:164.10 stddev:0.00 (0.0%) 09:02:26 INFO - 2015-11-16 09:02:26,515 DEBUG : BROWSER_OUTPUT: Values: 164.1 09:02:26 INFO - 2015-11-16 09:02:26,515 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,516 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:191.53 Median:191.53 stddev:0.00 (0.0%) 09:02:26 INFO - 2015-11-16 09:02:26,516 DEBUG : BROWSER_OUTPUT: Values: 191.5 09:02:26 INFO - 2015-11-16 09:02:26,516 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,516 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:279.33 Median:279.33 stddev:0.00 (0.0%) 09:02:26 INFO - 2015-11-16 09:02:26,516 DEBUG : BROWSER_OUTPUT: Values: 279.3 09:02:26 INFO - 2015-11-16 09:02:26,516 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,516 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5035.18 Median:5035.18 stddev:0.00 (0.0%) 09:02:26 INFO - 2015-11-16 09:02:26,517 DEBUG : BROWSER_OUTPUT: Values: 5035.2 09:02:26 INFO - 2015-11-16 09:02:26,517 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,517 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1988.07 Median:1988.07 stddev:0.00 (0.0%) 09:02:26 INFO - 2015-11-16 09:02:26,517 DEBUG : BROWSER_OUTPUT: Values: 1988.1 09:02:26 INFO - 2015-11-16 09:02:26,517 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,517 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:817.81 Median:817.81 stddev:0.00 (0.0%) 09:02:26 INFO - 2015-11-16 09:02:26,517 DEBUG : BROWSER_OUTPUT: Values: 817.8 09:02:26 INFO - 2015-11-16 09:02:26,517 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,518 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:11940.48 Median:11940.48 stddev:0.00 (0.0%) 09:02:26 INFO - 2015-11-16 09:02:26,518 DEBUG : BROWSER_OUTPUT: Values: 11940.5 09:02:26 INFO - 2015-11-16 09:02:26,518 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,518 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:26315.79 Median:26315.79 stddev:0.00 (0.0%) 09:02:26 INFO - 2015-11-16 09:02:26,518 DEBUG : BROWSER_OUTPUT: Values: 26315.8 09:02:26 INFO - 2015-11-16 09:02:26,518 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,518 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:620.35 Median:620.35 stddev:0.00 (0.0%) 09:02:26 INFO - 2015-11-16 09:02:26,519 DEBUG : BROWSER_OUTPUT: Values: 620.3 09:02:26 INFO - 2015-11-16 09:02:26,519 DEBUG : BROWSER_OUTPUT: 09:02:26 INFO - 2015-11-16 09:02:26,519 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4835.75 Median:4835.75 stddev:0.00 (0.0%) 09:02:26 INFO - 2015-11-16 09:02:26,519 DEBUG : BROWSER_OUTPUT: Values: 4835.7 09:02:26 INFO - 2015-11-16 09:02:26,519 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 09:02:26 INFO - 2015-11-16 09:02:26,519 DEBUG : BROWSER_OUTPUT: 09:02:27 INFO - 2015-11-16 09:02:27,412 INFO : Browser exited with error code: 0 09:02:27 INFO - 2015-11-16 09:02:27,429 INFO : Completed test v8_7 (00:00:39) 09:02:27 INFO - 2015-11-16 09:02:27,557 INFO : Completed test suite (00:20:17) 09:02:27 INFO - 2015-11-16 09:02:27,557 DEBUG : Working with test: dromaeo_css 09:02:27 INFO - 2015-11-16 09:02:27,557 DEBUG : Generating results file: dromaeo_css 09:02:27 INFO - 2015-11-16 09:02:27,559 DEBUG : Working with test: kraken 09:02:27 INFO - 2015-11-16 09:02:27,559 DEBUG : Generating results file: kraken 09:02:27 INFO - 2015-11-16 09:02:27,559 INFO : javascript benchmark 09:02:27 INFO - 2015-11-16 09:02:27,559 DEBUG : Working with test: v8_7 09:02:27 INFO - 2015-11-16 09:02:27,559 DEBUG : Generating results file: v8_7 09:02:27 INFO - 2015-11-16 09:02:27,560 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:02:27 INFO - 2015-11-16 09:02:27,609 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,203,35]] 09:02:27 INFO - 2015-11-16 09:02:27,609 DEBUG : process_Request line: dromaeo_css 6226.81 graph.html#tests=[[72,203,35]] 09:02:27 INFO - 2015-11-16 09:02:27,609 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:02:27 INFO - 2015-11-16 09:02:27,673 DEBUG : process_Request line: kraken 1525.50 graph.html#tests=[[232,203,35]] 09:02:27 INFO - 2015-11-16 09:02:27,673 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 09:02:27 INFO - 2015-11-16 09:02:27,724 DEBUG : process_Request line: v8_7 19782.71 graph.html#tests=[[230,203,35]] 09:02:27 INFO - 2015-11-16 09:02:27,726 INFO : javascript benchmark 09:02:27 INFO - 2015-11-16 09:02:27,728 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [344.60026369411486, 344.7052769881751, 344.97412694047944, 345.3042120127941, 345.67333869493325, 12498.937505312484, 12829.166104203221, 14854.628634284134, 15068.698626027473, 16625.750613740787, 10969.561217551289, 11251.54993800247, 11260.718482037953, 14560.126392416463, 15071.397144114222, 4060.2691515527194, 4122.608352206543, 4224.281872081738, 4239.5548467410945, 4241.257779888522, 3158.8578513966927, 3227.757918156136, 4251.171021650779, 4576.542345765413, 4637.188492013884, 4558.703684260512, 4569.862904112882, 4572.634189264867, 4578.130155270488, 4627.884302892421, 4557.339185818055, 4562.5665561771575, 4596.080783843228, 5936.495397891184, 6166.506679465632, 5763.740631671585, 5857.4435428634215, 5892.23400957877, 5920.79277225295, 5923.348431672513, 18974.81025189744, 19397.709034364354, 19561.21755129793, 20296.49258768528, 20485.180592776273, 1796.5957659526632, 1842.2446796813376, 1889.811018898113, 1898.0604600722731, 2048.068129001301, 12884.098113132084, 13140.474381024747, 13152.6711832204, 13269.071165018453, 13479.595612131652, 1718.501634525986, 1801.9459416217535, 1839.5401149712573, 1840.9815901840943, 1862.534366408398, 61318.386816131715, 63214.36785632131, 63355.683221584055, 63549.68225158891, 63615.045774313425, 15063.849361506464, 15638.687226255639, 15656.373745050298, 15669.686606268038, 15747.606309842116, 22911.656325155134, 22941.541169176522, 23146.421339466648, 23148.65277020846, 23218.8839055807, 8192.0, 8496.0, 8568.314534837198, 8660.393772435995, 8717.782055448664, 7204.963975180195, 7238.457115716237, 7245.058142441449, 7257.237990011078, 7283.562986220843, 7523.3981281497345, 7654.770356889302, 7656.540607563564, 7657.731979380695, 7680.270374314431, 1093.923425360233, 2044.2640649366217, 2928.5314349703945, 2993.0, 3050.4966680497914, 350.50753691064097, 384.13186199189477, 391.20194802602373, 396.738152819138, 406.9776162311101, 10045.246606504541, 10426.739331516621, 10608.992145746142, 10727.356358618508, 10788.244822862482, 395.83572817281083, 406.3620116417256, 410.9568495308009, 418.49362271651034, 445.7102883125929, 5293.20601909709, 5805.709714514257, 6231.968840155861, 6236.282827474808, 6390.041493775971, 479822.0, 492912.53543732053, 493558.9830762707, 493730.0, 498231.0, 65942.34057659458, 68256.0, 68759.0, 69719.0, 72242.27757722461, 472.1383475157782, 480.4210925834361, 480.42829033450084, 481.21802071633596, 482.9541193586674, 10052.145567626541, 10088.495575221357, 10094.596216151273, 10136.44249566281, 10224.130948869131, 30104.849475752482, 32813.67186328202, 33005.66994330026, 34154.48768268428, 34203.75064368881, 36279.63720362762, 39054.6094539051, 39365.0, 39855.40216896691, 40615.59384406118, 5686.0, 5761.798337058183, 5803.506701930383, 5807.477327040587, 5811.244538210006, 10133.0, 10213.540390682585, 10468.162546996069, 10481.947590262305, 10512.737181570215, 8591.87112193305, 8635.611397487253, 8651.567421629019, 8940.73177804667, 9476.47879366614, 9327.81344373095, 9344.532773361168, 9375.390599611004, 9476.952615237156, 9719.17387022111, 9141.131592498701, 9232.676856309998, 9279.907200927904, 9413.952930235306, 9452.0, 5488.259085023471, 5627.915581266366, 5807.157962095557, 6231.532635052298, 6446.935530644633, 9657.613695452103, 9785.266105042292, 9849.852252216078, 9858.556364963737, 10312.917143699804], "dojo.html": [2640.603909413588, 2720.986395068024, 2729.6997330293675, 2741.6984131745503, 2752.5871119332096, 4596.218642830719, 4702.24764037754, 4706.152892479361, 4786.952130478699, 4828.2274836026245, 4796.640251981098, 4818.08456393285, 4887.144749668802, 4900.0, 4902.044101400228, 4420.0496893167965, 4491.30384790358, 4515.412996310483, 4595.241785105453, 4650.372199753041, 4302.569743025688, 4400.647948164155, 4536.9791796845775, 4581.725096494204, 4595.379623750801, 4342.848000320006, 4432.135733531963, 4435.3790469334, 4442.755648439334, 4463.799129039168, 4477.664175186841, 4479.148961697267, 4479.193745125876, 4504.977475112636, 4534.433195850519, 4249.256380133495, 4376.89057773555, 4434.0, 4458.57643523868, 4469.128519938613, 4667.8599642010795, 4759.714417134983, 4779.545943135397, 4785.3300537924715, 4817.470078291385, 5181.948180518184, 5186.896262074775, 5190.4031036430915, 5194.091034069061, 5220.634555581111, 4918.409790825088, 5034.496550344973, 5039.697618142886, 5202.08963431398, 5213.113770658997, 4679.953200467986, 4835.6131509479155, 4838.782254798542, 4843.951560484421, 4884.633652476078, 5293.179557168568, 5296.25852380667, 5297.973510132425, 5299.761510732026, 5343.919841202385, 4833.540813622701, 4940.061388336205, 4941.48114447985, 5092.28707980883, 5099.082165210298, 5132.897342053138, 5234.110201265794, 5235.869103272373, 5239.47605239473, 5279.577633789288, 5151.9484805152215, 5158.664686795346, 5162.6902385856965, 5165.276861239429, 5202.375714914158, 4892.412910450768, 4998.4251811042195, 5008.64939454242, 5125.718085505333, 5127.384713834289, 3871.457995880579, 3946.1121247719607, 3957.08986933007, 3974.3044967130636, 3974.5429275633096, 3511.1046683095647, 3511.455724362728, 3512.3150985557572, 3539.876104336336, 3540.7875527468436, 4219.78901054946, 4484.663650226246, 4492.528284530077, 4493.236149854467, 4527.1172121436, 5067.594592432597, 5107.463716309734, 5134.409542902614, 5136.280920671109, 5197.8440646780655, 4452.443444569429, 4469.776511174493, 4472.0, 4477.104579084131, 4512.029913568598, 4294.420253265832, 4547.840825571089, 4548.840790572314, 4553.362529245908, 4588.472325682523, 4691.483936766953, 4710.905781884411, 4773.474917758975, 4827.444843843003, 4882.121218180761, 5201.063808514504, 5233.555147812479, 5236.26628841418, 5239.26650268955, 5279.551238144647, 4699.436067671902, 4959.82640607577, 4962.900741985068, 4963.131451995959, 4963.751812409438, 5029.4719054498755, 5044.722540260174, 5085.898282034264, 5188.429272779916, 5210.6613070150315, 5124.615653825904, 5136.203888397305, 5138.588912886886, 5142.897142057063, 5167.22491626259, 4798.352222449925, 4970.975145124251, 4975.975120124376, 4996.300517927566, 5009.974950125226, 4894.951050489592, 4939.5554400104165, 4944.431390390151, 4983.601311894967, 5012.649114561946, 4918.2868484068895, 4918.778654960463, 4921.803127874845, 4923.655344125877, 4924.212126059957, 4828.734419606955, 5039.672421292605, 5044.772985215601, 5047.444781074006, 5077.136886729191, 4841.080194762983, 4862.756862156949, 4878.463369029333, 4927.457979622167, 4937.308776771183], "mootools.html": [1173.3605185174079, 1612.9112898790565, 1654.1315809200169, 1690.9154542272888, 1699.7620333153352, 6028.728707208175, 6674.332566743323, 6777.356151165632, 6800.319968003203, 6833.726650933969, 6792.388685018347, 6937.791866244008, 6940.410065144456, 6953.44372450204, 6971.128608923885, 2020.5150763816653, 2042.8876411797346, 2047.2220556188702, 2047.2834507922182, 2048.252387878421, 2083.9687404688943, 2088.6866969954553, 2092.184048221195, 2097.4336929029155, 2108.1988844239168, 2004.0380617303704, 2006.9899650501727, 2014.48630599197, 2016.0625309231204, 2016.6269240190538, 1998.0808827939165, 2008.6183625111255, 2012.0744457549545, 2013.1041686449537, 2013.7382140321665, 2026.5845501672122, 2052.004777682823, 2059.1454546363393, 2059.680749483832, 2060.2274147194803, 5709.714514274269, 5880.029795083806, 6864.725410983555, 6905.102336696247, 6908.516403851732, 4032.6773858091283, 4128.422020917044, 4151.958480415187, 4162.4796900387455, 4175.645070169039, 2740.082072505713, 2786.3591373983895, 2832.830030198195, 2843.218115018366, 2871.0095017219237, 900.8423525882944, 901.8151278987792, 916.862470629411, 925.8657494663304, 927.429630777074, 9321.766955826091, 9381.202597779196, 9389.483578403117, 9396.389234699722, 9402.106799854002, 3874.341361968472, 3881.0879443330796, 3924.430957511202, 3929.8428062877165, 3974.6621537169663, 8132.430729848854, 8162.0, 8162.510249385056, 8168.714095006765, 8170.346372290202, 4216.262154123016, 4217.325227963511, 4218.6835987300465, 4221.78891055446, 4225.492940847118, 3806.7525610835205, 3808.124131449782, 3816.4466152407745, 3818.6563209311294, 3820.675242604354, 3255.4465740823644, 3259.918502037468, 3282.1958620137743, 3298.2578919742864, 3304.3556506481004, 1025.564135242519, 1039.2125544064197, 1047.8113939490966, 1047.9528421221064, 1053.1416895230363, 905.3888625177979, 983.5033308179324, 1151.1423989128152, 1179.2688533109356, 1181.2321990705939, 6483.222013358427, 6498.025296205513, 6512.804615861532, 6515.0, 6532.150820393414, 1026.8408396698524, 1034.2036631793476, 1041.2450973044633, 1045.5869931377215, 1068.8824229334766, 4729.385179926588, 5149.716765577929, 5225.190095535198, 5226.189940559219, 5241.73791310433, 7193.820154496075, 7925.207479252029, 8089.635966381527, 8105.6757729691335, 8105.918940810517, 7926.326262267657, 7977.521348718979, 7977.760667179994, 7977.840443191104, 7986.7603971880935, 6426.807195784134, 6593.076969224312, 6638.7676431325635, 6653.135092438049, 6689.632070236184, 6577.079208910661, 6594.472442204708, 6616.867662646817, 6618.966905165444, 6646.501512386687, 7315.743948961761, 7507.737229196952, 7516.173220945801, 7543.660535276035, 7569.394448444222, 7501.549907005598, 7677.884831727641, 7854.450188486751, 7887.369010479033, 7903.407244456574, 5485.314335708036, 5521.779128834802, 5556.111022236423, 5642.181883626933, 5799.101139323411, 6537.542372033912, 6566.343365663395, 6613.0, 6615.768448104293, 6627.50293727982, 6231.40801623845, 6289.874202515833, 6373.904391434039, 6405.167328247298, 6456.160699109086, 6018.608790428783, 6102.755889764538, 6103.206583144341, 6188.412100850412, 6229.034499652561, 6315.652639104894, 6368.617882927039, 6378.52161087911, 6385.7126429309865, 6390.265119511316, 5822.184894114912, 5833.0375488044, 5844.590878638454, 5851.853703657443, 5860.413958604276, 5699.458551437607, 5844.736986835517, 5871.853203669943, 5873.500752436091, 5874.089516124836], "ext.html": [575.7322844877132, 577.7457918515855, 582.7523302596398, 588.4204059001885, 594.4560726934855, 28891.0, 29707.70292297079, 38602.22795544091, 39417.605823941754, 39442.80278598603, 42543.361849572284, 42954.140917181634, 43118.353224701656, 43170.784146079226, 43326.0, 7128.821779455503, 7975.840483190333, 8153.184681531859, 8153.8776918346275, 8160.551169685665, 7201.387882030033, 10381.169506439466, 10637.57449702011, 10639.468026598677, 10647.361158330486, 10328.431936243504, 10417.583296668125, 10457.895421045807, 10462.11072058872, 10465.633702820403, 7287.817804554876, 7458.6270686466005, 10319.638812641559, 10424.739381515446, 10437.478126093665, 9845.50772461374, 9961.950190249003, 9971.90028099717, 9978.301518893608, 9986.151177149952, 38108.0, 38654.80672596619, 38697.806510967544, 38702.225955481015, 38715.0, 2896.0, 3044.0106965236387, 3044.6803085675906, 3177.809331440121, 3422.0076177908377, 29385.0, 29534.11397658074, 29649.258768530744, 30005.699943000727, 30172.396552069054, 3125.984370078158, 3185.7451403887635, 3187.42626327261, 3218.6620404857385, 3242.886498972525, 233734.0, 234551.0, 235424.0, 235714.0, 235920.0, 52269.47730522722, 53557.46442535525, 58785.706071470224, 59284.70357648184, 63989.36010639834, 59286.70356648189, 59315.70342148262, 59326.0, 59362.0, 59492.405075948685, 13201.07592468518, 13511.527096551574, 13560.0, 13568.660783480493, 13585.456581736818, 9749.0, 9757.26820488452, 9760.853587196198, 9767.16979056774, 9778.119969202806, 19430.611387772165, 19892.90053549723, 19974.800251997585, 20044.398668039983, 20103.39689809308, 7079.256678048834, 7151.427885769126, 7255.56466612005, 7276.63616819157, 7317.926820731831, 794.5749024271987, 820.2863508747428, 821.6097353756918, 876.3120950054305, 943.6036864516919, 23933.251037375074, 25899.870500647376, 26059.348516286864, 26444.867775660998, 26550.86724566365, 812.212154210415, 830.6552780596106, 850.8170743290223, 962.4802606592361, 974.016243593961, 12964.546240881713, 13332.400181964618, 13700.24648644334, 14533.92733036328, 15195.164265965477, 210532.0, 213707.0, 213746.0, 213863.0, 214113.0, 43328.133437331075, 43394.132117357476, 43468.782656086514, 43551.0, 43561.78219108948, 1206.1315852586124, 1211.8303437518755, 1214.059104194239, 1219.9756004879853, 1341.7651910915747, 26139.738602613732, 28180.0, 28355.432891341647, 28375.29061773472, 28861.855690722252, 37223.627763723096, 38299.23401531898, 43463.348049778644, 44302.11395772002, 44357.556424435345, 212682.0, 213727.0, 214192.0, 214436.0, 214456.0, 24614.261572152864, 25289.367765806, 28813.56779648265, 29148.27129321784, 29169.854150729112, 37917.05207369838, 38372.42441363438, 38925.02687432837, 39710.02899710006, 40344.0, 30024.69975300219, 30315.0, 30904.690953090183, 31341.843290784313, 31368.215794605316, 31230.37539249157, 31418.528722069645, 31611.84194079015, 31624.0, 31673.524897127023, 33735.97584144959, 33855.66144338525, 33908.83045584855, 34399.0, 34792.13019674427, 28023.159305220877, 29307.0, 30900.0, 31377.372452550364, 31488.527672085394, 21438.785612143678, 21746.347609571738, 21886.89056554707, 21980.340589782332, 21994.0], "prototype.html": [284.38572683004713, 292.304315728566, 295.44603867747975, 297.2702016549371, 303.55377594935436, 5399.055165346068, 5411.621186516945, 5474.39781624021, 5477.3427188737305, 5480.451954804527, 5355.0, 5366.973165134179, 5376.059189641816, 5376.973115134429, 5377.919331210035, 4191.077962848169, 4192.454980852485, 4192.895177620553, 4193.308104162825, 4196.580341965794, 3989.501312335958, 4055.9391609125887, 4072.0837811492474, 4135.627793498585, 4171.541130475645, 4124.711270211072, 4139.068709540359, 4142.357934520154, 4147.937780933288, 4156.231097247004, 3932.9803350983348, 4067.450894129314, 4140.068484590973, 4154.023804405962, 4154.1068670235745, 3524.1189702574356, 3611.693006094485, 3624.311380837659, 3627.6916462100753, 3628.7641303315463, 5183.429822719498, 5184.559312458446, 5188.092083885305, 5200.479952004807, 5208.8437346879655, 4739.857804265877, 4771.260454629538, 4771.856844294677, 4772.6420518461255, 4783.067301876135, 5501.834944951618, 5667.263255776723, 5671.291088613923, 5673.546116310686, 5711.8000869969355, 3821.216650586623, 3834.7123965702685, 3838.347480928249, 3838.4818049563232, 3838.980805095957, 5901.3508514063415, 6005.4895333896675, 6010.338862725097, 6018.6689732064715, 6019.69901504923, 3869.1101046759404, 3871.9806400968378, 3872.9225415491533, 3879.2047630236298, 3882.0, 3864.381698928158, 3931.488906442144, 3940.625640564142, 3941.231459865356, 3944.9408258876138, 4657.1617108920045, 4670.065986802653, 4670.906581868344, 4675.95324046762, 4679.040796636749, 5692.345380281238, 5703.315602127771, 5717.256756621696, 5719.828405147852, 5725.055365864669, 1374.4776984745733, 1379.2896658221025, 1380.3374380297514, 1381.0884816021378, 1384.0, 901.8331608652289, 916.2990312411011, 923.607466826596, 929.697848199338, 933.8132373525322, 5047.924281135786, 5058.367704036996, 5059.19052951526, 5062.493750624908, 5065.164247899055, 5917.852053698692, 5920.171176035358, 5928.525717942554, 5930.614510056833, 5931.673757943355, 5044.066847633199, 5044.621653375938, 5044.848654540369, 5045.268436076748, 5050.747462626854, 3115.4392209402527, 3178.1419016865316, 3191.9680803192136, 3197.257494665413, 3202.6797320267788, 5587.05020146576, 5593.8321850344555, 5596.748146333425, 5598.58010649203, 5598.692071936001, 6075.756969721162, 6080.14877917092, 6085.117657939574, 6085.300190478063, 6089.330173680892, 5454.727263636882, 5574.358948720868, 5579.218909352694, 5588.580856435784, 5600.523955463831, 5896.675682837314, 5901.0558310670085, 5905.350411454822, 5908.704564771659, 5924.348321684525, 5763.8559036024435, 5782.277215348082, 5786.479216870502, 5787.623804452697, 5800.332961709458, 5577.219189313419, 5582.49757521825, 5592.384837667934, 5593.02122128634, 5596.496315331639, 3841.2701586698436, 3978.6419222270133, 3995.780232087147, 3996.320625493615, 3996.3406038003404, 5893.764249430146, 5909.91135132982, 5915.763369465173, 5918.940810592011, 5924.851878703067, 5673.404292549223, 5698.1452782083015, 5701.0, 5710.685912274865, 5713.542916566747, 5529.060059789926, 5687.118496633028, 5697.23087383198, 5699.829005129853, 5703.230063941315, 5558.555315574664, 5567.3040869891265, 5598.748056337393, 5610.242617246619, 5615.0, 5511.559075273888, 5684.7157642118555, 5761.510271626791, 5764.913526297025, 5778.768849245983, 5441.918371224514, 5565.220869078414, 5571.275734154534, 5616.85957851057, 5649.802256920988], "yui.html": [656.7373050779689, 734.5996431944591, 779.4777499075619, 789.3487872505185, 801.9398545109115, 11972.401379931001, 12082.939585302061, 12133.757324853497, 12142.271463712183, 12142.514299428023, 11773.293602383841, 11869.109816763734, 11872.7625447491, 11881.108916831228, 11885.940570297158, 610.3408319015475, 616.312811215496, 761.603965937712, 775.806048487878, 799.021199031185, 793.2503783924166, 795.0221227889699, 800.2757504458474, 800.9839803203932, 801.0907619851453, 827.5531213144894, 834.7871292820353, 842.1115722912325, 843.2284459719349, 843.9620217090215, 636.567134348645, 644.3846126948753, 817.1256755271831, 829.639106988462, 830.6345208108413, 615.2125279642065, 615.722924683894, 615.8214117905802, 616.4821549898107, 616.5714828194407, 12178.878211217863, 12336.814947775702, 12344.382780861011, 12345.0, 12350.135490515668, 11254.212205145643, 11753.588624398106, 11814.763704725858, 12054.0, 12151.696207594881, 9458.668946586906, 9589.808203835884, 9656.27577931658, 9736.902630973671, 9973.90026099737, 3199.9840000799845, 3216.758743094254, 3257.853396597135, 3271.9182020449443, 3322.634510203876, 40893.18213635711, 40909.38635920463, 41009.38485922714, 41040.179196416204, 41045.384319235236, 9337.953310233406, 9661.758456038655, 9681.70954871355, 9765.755856103655, 9774.51127443625, 17187.226574804165, 17195.742063869053, 17209.655806884042, 17219.0, 17233.0, 5723.713814309268, 5856.1508581255475, 5947.6431414115295, 6467.838304042437, 6774.8645027100165, 3664.2488289900507, 3666.633336666312, 3666.7066634669695, 3687.8340474678703, 3731.645493678096, 2360.6223004319227, 2390.5696974544403, 2392.964105538418, 2393.0906255622754, 2393.7606239375923, 392.15881933253013, 397.66000069939787, 446.54006373435413, 460.7051487048292, 461.66298602020714, 479.302614695617, 487.63671065056053, 600.6366148480193, 640.8558074433215, 649.4187702006677, 7018.543794653433, 7787.299143077037, 7829.725959591501, 7934.166912474223, 8043.557604331818, 478.51430797740323, 531.9255304257407, 577.9768809247668, 595.1964847455899, 599.4574909706722, 3582.7133829293593, 3645.6172101929446, 3821.1975485147873, 3883.37865941448, 3925.0187453136714, 46624.53375466202, 50238.74880625573, 50336.24495632568, 52985.735071324394, 53556.46443535593, 45034.32448513275, 45369.546304537194, 45964.310535341996, 46223.76888115538, 47260.7636961813, 42790.144197115886, 42849.571504284555, 43334.7833260838, 43407.782961084995, 43504.0, 7929.207079292255, 8309.584520774059, 8337.374696897636, 8384.32925365957, 8591.742247732578, 32262.0, 32660.510092349108, 33043.66956330502, 33198.17004574905, 33299.83350083234, 41622.1675566493, 42209.57790422056, 42325.0, 42707.0, 44582.55417445784, 10292.948535257276, 10993.0, 10999.61501347449, 11135.498902549567, 11300.886991129983, 11707.180497365103, 11906.76186476283, 11962.58130965412, 11969.341686207343, 12260.08049396281, 10525.210609204187, 10533.262671612914, 10746.892531074589, 10868.565257389932, 11165.330080195214, 10969.286996345212, 10970.616028438966, 11033.558657653924, 11243.66269011931, 11597.420128993348, 10801.459927003461, 10924.399158046066, 10932.890671093188, 11066.39134847591, 11141.944290278821, 9535.713928582154, 9721.85417218728, 9824.477801604331, 9874.245447804782, 9990.0, 9408.153266206074, 9635.951820241135, 9756.121949024622, 9761.170300524534, 9764.218862491125]}, "summary": {"lowerIsBetter": false, "suite": 6226.815027958759, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 7399.814529393955, "unit": "ms", "value": 7399.814529393955}, "dojo.html": {"lowerIsBetter": false, "filtered": 4696.12562801454, "unit": "ms", "value": 4696.12562801454}, "mootools.html": {"lowerIsBetter": false, "filtered": 4014.634432218294, "unit": "ms", "value": 4014.634432218294}, "ext.html": {"lowerIsBetter": false, "filtered": 17023.57342945094, "unit": "ms", "value": 17023.57342945094}, "prototype.html": {"lowerIsBetter": false, "filtered": 4228.454013695649, "unit": "ms", "value": 4228.454013695649}, "yui.html": {"lowerIsBetter": false, "filtered": 5803.807452776582, "unit": "ms", "value": 5803.807452776582}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-039"}, "testrun": {"date": 1447692129, "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": "20151116075758", "branch": "B2G-Inbound-Non-PGO", "revision": "9143161fa821bce46c9d4ce47ed4882e92330656"}}, {"talos_counters": {}, "results": {"audio-dft": [162.0, 161.0, 160.0, 161.0, 161.0, 160.0, 165.0, 160.0, 162.0, 161.0], "ai-astar": [109.0, 113.0, 106.0, 111.0, 113.0, 113.0, 102.0, 110.0, 115.0, 111.0], "imaging-gaussian-blur": [108.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0, 109.0], "audio-beat-detection": [157.0, 132.0, 151.0, 175.0, 134.0, 156.0, 154.0, 132.0, 166.0, 138.0], "json-stringify-tinderbox": [69.0, 68.0, 68.0, 69.0, 69.0, 69.0, 68.0, 69.0, 69.0, 68.0], "stanford-crypto-pbkdf2": [157.0, 143.0, 161.0, 169.0, 151.0, 142.0, 161.0, 149.0, 150.0, 143.0], "json-parse-financial": [68.0, 70.0, 69.0, 69.0, 69.0, 70.0, 69.0, 77.0, 67.0, 68.0], "stanford-crypto-sha256-iterative": [71.0, 69.0, 71.0, 70.0, 69.0, 68.0, 68.0, 69.0, 68.0, 70.0], "audio-fft": [73.0, 73.0, 84.0, 90.0, 73.0, 73.0, 72.0, 122.0, 89.0, 74.0], "imaging-darkroom": [148.0, 148.0, 147.0, 148.0, 148.0, 148.0, 147.0, 147.0, 147.0, 147.0], "stanford-crypto-ccm": [118.0, 126.0, 118.0, 122.0, 125.0, 130.0, 119.0, 120.0, 140.0, 121.0], "audio-oscillator": [92.0, 91.0, 123.0, 92.0, 92.0, 90.0, 141.0, 92.0, 92.0, 125.0], "stanford-crypto-aes": [81.0, 83.0, 86.0, 84.0, 84.0, 86.0, 83.0, 82.0, 84.0, 83.0], "imaging-desaturate": [95.0, 95.0, 96.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0]}, "summary": {"lowerIsBetter": true, "suite": 1525.4999999999998, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 82.3, "unit": "ms", "value": 82.3}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 152.6, "unit": "ms", "value": 152.6}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 149.5, "unit": "ms", "value": 149.5}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 123.9, "unit": "ms", "value": 123.9}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 147.5, "unit": "ms", "value": 147.5}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 69.6, "unit": "ms", "value": 69.6}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 103.0, "unit": "ms", "value": 103.0}, "ai-astar": {"lowerIsBetter": true, "filtered": 110.3, "unit": "ms", "value": 110.3}, "audio-dft": {"lowerIsBetter": true, "filtered": 161.3, "unit": "ms", "value": 161.3}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 69.3, "unit": "ms", "value": 69.3}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 68.6, "unit": "ms", "value": 68.6}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 108.9, "unit": "ms", "value": 108.9}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 83.6, "unit": "ms", "value": 83.6}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 95.1, "unit": "ms", "value": 95.1}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-039"}, "testrun": {"date": 1447692129, "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": "20151116075758", "branch": "B2G-Inbound-Non-PGO", "revision": "9143161fa821bce46c9d4ce47ed4882e92330656"}}, {"talos_counters": {}, "results": {"DeltaBlue": [191.5341888527102], "Encrypt": [279.3296089385475], "NavierStokes": [4835.748792270531], "Decrypt": [5035.175879396985], "Splay": [620.3473945409429], "Richards": [164.09583196586806], "RegExp": [26315.78947368421], "Earley": [817.8104575163399], "Boyer": [11940.47619047619], "RayTrace": [1988.0715705765408]}, "summary": {"lowerIsBetter": false, "suite": 19782.714431414544, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 345.2020779999999, "unit": "score", "value": 345.2020779999999}, "Encrypt": {"lowerIsBetter": false, "filtered": 952.9279799999998, "unit": "score", "value": 952.9279799999998}, "NavierStokes": {"lowerIsBetter": false, "filtered": 306.881118881119, "unit": "score", "value": 306.881118881119}, "Decrypt": {"lowerIsBetter": false, "filtered": 52.864290419161705, "unit": "score", "value": 52.864290419161705}, "Splay": {"lowerIsBetter": false, "filtered": 131.363492, "unit": "score", "value": 131.363492}, "RegExp": {"lowerIsBetter": false, "filtered": 34.61742999999998, "unit": "score", "value": 34.61742999999998}, "Richards": {"lowerIsBetter": false, "filtered": 215.13038799999993, "unit": "score", "value": 215.13038799999993}, "Earley": {"lowerIsBetter": false, "filtered": 814.9357762237764, "unit": "score", "value": 814.9357762237764}, "Boyer": {"lowerIsBetter": false, "filtered": 55.815445663010976, "unit": "score", "value": 55.815445663010976}, "RayTrace": {"lowerIsBetter": false, "filtered": 372.21446699999984, "unit": "score", "value": 372.21446699999984}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-039"}, "testrun": {"date": 1447692129, "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": "20151116075758", "branch": "B2G-Inbound-Non-PGO", "revision": "9143161fa821bce46c9d4ce47ed4882e92330656"}}] 09:02:27 INFO - RETURN: dromaeo_css: 6226.81 09:02:27 INFO - RETURN: kraken: 1525.50 09:02:27 INFO - RETURN: v8_7: 19782.71 09:02:27 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,203,35]]", "result": "19782.71"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,203,35]]", "result": "1525.50"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,203,35]]", "result": "6226.81"}}} 09:02:27 INFO - Return code: 0 09:02:27 INFO - # TBPL SUCCESS # 09:02:27 INFO - Running post-action listener: _resource_record_post_action 09:02:27 INFO - Running post-run listener: _resource_record_post_run 09:02:28 INFO - Total resource usage - Wall time: 1233s; CPU: 13.0%; Read bytes: 0; Write bytes: 507883520; Read time: 0; Write time: 689528 09:02:28 INFO - install - Wall time: 15s; CPU: 14.0%; Read bytes: 0; Write bytes: 169766912; Read time: 0; Write time: 260860 09:02:28 INFO - run-tests - Wall time: 1218s; CPU: 13.0%; Read bytes: 0; Write bytes: 333398016; Read time: 0; Write time: 428396 09:02:28 INFO - Running post-run listener: _upload_blobber_files 09:02:28 INFO - Blob upload gear active. 09:02:28 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 09:02:28 INFO - Copying logs to upload dir... 09:02:28 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1264.822201 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 4 secs) (at 2015-11-16 09:02:28.446879) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-16 09:02:28.450581) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/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/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447691731.338944-2088164858 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009952 build_url: 'https://queue.taskcluster.net/v1/task/qh_e_TsTR_GbTEmw8Clviw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-16 09:02:28.501529) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 09:02:28.501861) ========= rm -f oauth.txt in dir /builds/slave/test/. (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 SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6e558709db315bacd2260379000001b6-1447691731.338944-2088164858 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004494 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-16 09:02:28.552051) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-16 09:02:28.552382) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-16 09:02:28.552680) ========= ========= Total master_lag: 0.24 =========