builder: b2g-inbound_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-045 starttime: 1449752017.54 results: success (0) buildid: 20151210034541 builduid: b39b1940ba14487bb4ba64344289d1e1 revision: c25d5a6ca04d3f4d1625190ccebf5cf58845927c ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.540075) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.540807) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.541129) ========= 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=61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006342 basedir: '/builds/slave/test' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.579157) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.579433) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.623116) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.623393) ========= 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=61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004586 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.672670) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.673003) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.673373) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.673666) ========= 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=61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-12-10 04:53:38-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 227M=0s 2015-12-10 04:53:38 (227 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.165584 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.853414) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.853730) ========= 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=61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017153 ========= master_lag: 0.07 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:37.941277) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-12-10 04:53:37.941657) ========= bash -c 'python archiver_client.py mozharness --repo integration/b2g-inbound --rev c25d5a6ca04d3f4d1625190ccebf5cf58845927c --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 c25d5a6ca04d3f4d1625190ccebf5cf58845927c --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=61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-12-10 04:53:39,089 truncating revision to first 12 chars 2015-12-10 04:53:39,089 Setting DEBUG logging. 2015-12-10 04:53:39,089 attempt 1/10 2015-12-10 04:53:39,089 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/b2g-inbound/c25d5a6ca04d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-12-10 04:53:39,869 unpacking tar archive at: b2g-inbound-c25d5a6ca04d/testing/mozharness/ program finished with exit code 0 elapsedTime=1.108599 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-12-10 04:53:39.063061) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:39.063357) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:39.072205) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:39.072457) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-12-10 04:53:39.072844) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2015-12-10 04:53:39.073147) ========= /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=61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:53:40 INFO - MultiFileLogger online at 20151210 04:53:40 in /builds/slave/test 04:53:40 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 04:53:40 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:53:40 INFO - {'append_to_log': False, 04:53:40 INFO - 'base_work_dir': '/builds/slave/test', 04:53:40 INFO - 'blob_upload_branch': 'B2G-Inbound-Non-PGO', 04:53:40 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:53:40 INFO - 'branch': 'B2G-Inbound-Non-PGO', 04:53:40 INFO - 'buildbot_json_path': 'buildprops.json', 04:53:40 INFO - 'config_files': ('talos/linux_config.py',), 04:53:40 INFO - 'default_actions': ('clobber', 04:53:40 INFO - 'read-buildbot-config', 04:53:40 INFO - 'download-and-extract', 04:53:40 INFO - 'populate-webroot', 04:53:40 INFO - 'create-virtualenv', 04:53:40 INFO - 'install', 04:53:40 INFO - 'run-tests'), 04:53:40 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:53:40 INFO - 'download_minidump_stackwalk': True, 04:53:40 INFO - 'download_symbols': 'ondemand', 04:53:40 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:53:40 INFO - 'tooltool.py': '/tools/tooltool.py', 04:53:40 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:53:40 INFO - '/tools/misc-python/virtualenv.py')}, 04:53:40 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:53:40 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:53:40 INFO - 'installer_path': 'installer.exe', 04:53:40 INFO - 'log_level': 'info', 04:53:40 INFO - 'log_name': 'talos', 04:53:40 INFO - 'log_to_console': True, 04:53:40 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:53:40 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:53:40 INFO - 'opt_config_files': (), 04:53:40 INFO - 'pip_index': False, 04:53:40 INFO - 'sps_profile': False, 04:53:40 INFO - 'sps_profile_interval': 0, 04:53:40 INFO - 'suite': 'dromaeojs', 04:53:40 INFO - 'system_bits': '64', 04:53:40 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:53:40 INFO - 'title': 'talos-linux64-ix-045', 04:53:40 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:53:40 INFO - 'use_talos_json': True, 04:53:40 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:53:40 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:53:40 INFO - 'work_dir': 'build'} 04:53:40 INFO - ##### 04:53:40 INFO - ##### Running clobber step. 04:53:40 INFO - ##### 04:53:40 INFO - Running pre-action listener: _resource_record_pre_action 04:53:40 INFO - Running main action method: clobber 04:53:40 INFO - rmtree: /builds/slave/test/build 04:53:40 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:53:41 INFO - Running post-action listener: _resource_record_post_action 04:53:41 INFO - ##### 04:53:41 INFO - ##### Running read-buildbot-config step. 04:53:41 INFO - ##### 04:53:41 INFO - Running pre-action listener: _resource_record_pre_action 04:53:41 INFO - Running main action method: read_buildbot_config 04:53:41 INFO - Using buildbot properties: 04:53:41 INFO - { 04:53:41 INFO - "properties": { 04:53:41 INFO - "buildnumber": 780, 04:53:41 INFO - "product": "firefox", 04:53:41 INFO - "script_repo_revision": "production", 04:53:41 INFO - "builddir": "b2g-inbound_ubuntu64_hw_test-dromaeojs", 04:53:41 INFO - "repository": "", 04:53:41 INFO - "buildername": "Ubuntu HW 12.04 x64 b2g-inbound talos dromaeojs", 04:53:41 INFO - "buildid": "20151210034541", 04:53:41 INFO - "slavename": "talos-linux64-ix-045", 04:53:41 INFO - "pgo_build": "False", 04:53:41 INFO - "basedir": "/builds/slave/test", 04:53:41 INFO - "project": "", 04:53:41 INFO - "platform": "ubuntu64_hw", 04:53:41 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 04:53:41 INFO - "slavebuilddir": "test", 04:53:41 INFO - "scheduler": "tests-b2g-inbound-linux64-talos", 04:53:41 INFO - "branch": "b2g-inbound", 04:53:41 INFO - "repo_path": "integration/b2g-inbound", 04:53:41 INFO - "stage_platform": "linux64", 04:53:41 INFO - "builduid": "b39b1940ba14487bb4ba64344289d1e1", 04:53:41 INFO - "revision": "c25d5a6ca04d3f4d1625190ccebf5cf58845927c" 04:53:41 INFO - }, 04:53:41 INFO - "sourcestamp": { 04:53:41 INFO - "repository": "", 04:53:41 INFO - "hasPatch": false, 04:53:41 INFO - "project": "", 04:53:41 INFO - "branch": "b2g-inbound-linux64-talos", 04:53:41 INFO - "changes": [ 04:53:41 INFO - { 04:53:41 INFO - "category": null, 04:53:41 INFO - "files": [ 04:53:41 INFO - { 04:53:41 INFO - "url": null, 04:53:41 INFO - "name": "https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 04:53:41 INFO - } 04:53:41 INFO - ], 04:53:41 INFO - "repository": "", 04:53:41 INFO - "rev": "c25d5a6ca04d3f4d1625190ccebf5cf58845927c", 04:53:41 INFO - "who": "cbook@mozilla.com", 04:53:41 INFO - "when": 1449751977, 04:53:41 INFO - "number": 7238667, 04:53:41 INFO - "comments": "Merge mozilla-central to b2g-inbound", 04:53:41 INFO - "project": "", 04:53:41 INFO - "at": "Thu 10 Dec 2015 04:52:57", 04:53:41 INFO - "branch": "b2g-inbound-linux64-talos", 04:53:41 INFO - "revlink": "", 04:53:41 INFO - "properties": [ 04:53:41 INFO - [ 04:53:41 INFO - "buildid", 04:53:41 INFO - "20151210034541", 04:53:41 INFO - "Change" 04:53:41 INFO - ], 04:53:41 INFO - [ 04:53:41 INFO - "builduid", 04:53:41 INFO - "b39b1940ba14487bb4ba64344289d1e1", 04:53:41 INFO - "Change" 04:53:41 INFO - ], 04:53:41 INFO - [ 04:53:41 INFO - "pgo_build", 04:53:41 INFO - "False", 04:53:41 INFO - "Change" 04:53:41 INFO - ] 04:53:41 INFO - ], 04:53:41 INFO - "revision": "c25d5a6ca04d3f4d1625190ccebf5cf58845927c" 04:53:41 INFO - } 04:53:41 INFO - ], 04:53:41 INFO - "revision": "c25d5a6ca04d3f4d1625190ccebf5cf58845927c" 04:53:41 INFO - } 04:53:41 INFO - } 04:53:41 INFO - Found installer url https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 04:53:41 INFO - Running post-action listener: _resource_record_post_action 04:53:41 INFO - ##### 04:53:41 INFO - ##### Running download-and-extract step. 04:53:41 INFO - ##### 04:53:41 INFO - Running pre-action listener: _resource_record_pre_action 04:53:41 INFO - Running main action method: download_and_extract 04:53:41 INFO - mkdir: /builds/slave/test/build/tests 04:53:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:53:41 INFO - https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 04:53:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/test_packages.json 04:53:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/test_packages.json 04:53:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 04:53:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 04:53:42 INFO - Downloaded 1302 bytes. 04:53:42 INFO - Reading from file /builds/slave/test/build/test_packages.json 04:53:42 INFO - Using the following test package requirements: 04:53:42 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 04:53:42 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:53:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:53:42 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:53:42 INFO - u'jsshell-linux-x86_64.zip'], 04:53:42 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:53:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:53:42 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 04:53:42 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:53:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:53:42 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:53:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:53:42 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:53:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:53:42 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 04:53:42 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:53:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:53:42 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:53: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')]} 04:53:42 INFO - https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:53:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:53:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:53:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/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 04:53:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/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 04:53:44 INFO - Downloaded 21866969 bytes. 04:53:44 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 04:53:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:53:44 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 04:53:45 INFO - Return code: 0 04:53:45 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 04:53:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:53:45 INFO - https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:53:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:53:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:53:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/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 04:53:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/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 04:53:47 INFO - Downloaded 21866969 bytes. 04:53:47 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 04:53:47 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:53:47 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 04:53:48 INFO - Return code: 0 04:53:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:53:48 INFO - https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:53:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 04:53:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 04:53:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/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 04:53:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/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 04:53:49 INFO - Downloaded 11132038 bytes. 04:53:49 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 04:53:49 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 04:53:49 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 04:53:49 INFO - Return code: 0 04:53:49 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')]} 04:53:49 INFO - https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:53:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 04:53:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 04:53:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/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 04:53:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/hTGMtL5SRuiaMKIQJem9Hg/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 04:53:51 INFO - Downloaded 57728139 bytes. 04:53:51 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 04:53:51 INFO - mkdir: /builds/slave/test/properties 04:53:51 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:53:51 INFO - Writing to file /builds/slave/test/properties/build_url 04:53:51 INFO - Contents: 04:53:51 INFO - build_url:https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 04:53:51 INFO - Running post-action listener: _resource_record_post_action 04:53:51 INFO - Running post-action listener: set_extra_try_arguments 04:53:51 INFO - ##### 04:53:51 INFO - ##### Running populate-webroot step. 04:53:51 INFO - ##### 04:53:51 INFO - Running pre-action listener: _resource_record_pre_action 04:53:51 INFO - Running main action method: populate_webroot 04:53:51 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:53:51 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:53:51 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:53:51 INFO - '--tppagecycles', 04:53:51 INFO - '7'], 04:53:51 INFO - 'tests': ['tsvgm']}}, 04:53:51 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 04:53:51 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 04:53:51 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:53:51 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:53:51 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 04:53:51 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:53:51 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:53:51 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:53:51 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:53:51 INFO - 'talos_options': ['--e10s'], 04:53:51 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:53:51 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:53:51 INFO - 'tests': ['damp', 'tps']}, 04:53:51 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:53:51 INFO - 'talos_options': ['--e10s'], 04:53:51 INFO - 'tests': ['damp', 'tps']}, 04:53:51 INFO - 'g3': {'tests': ['dromaeo_dom']}, 04:53:51 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:53:51 INFO - 'other': {'tests': ['a11yr', 04:53:51 INFO - 'ts_paint', 04:53:51 INFO - 'tpaint', 04:53:51 INFO - 'sessionrestore', 04:53:51 INFO - 'sessionrestore_no_auto_restore']}, 04:53:51 INFO - 'other-e10s': {'talos_options': ['--e10s'], 04:53:51 INFO - 'tests': ['a11yr', 04:53:51 INFO - 'ts_paint', 04:53:51 INFO - 'tpaint', 04:53:51 INFO - 'sessionrestore', 04:53:51 INFO - 'sessionrestore_no_auto_restore']}, 04:53:51 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 04:53:51 INFO - 'tests': ['a11yr', 04:53:51 INFO - 'ts_paint', 04:53:51 INFO - 'tpaint', 04:53:51 INFO - 'sessionrestore', 04:53:51 INFO - 'sessionrestore_no_auto_restore']}, 04:53:51 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 04:53:51 INFO - 'tests': ['a11yr', 04:53:51 INFO - 'ts_paint', 04:53:51 INFO - 'tpaint', 04:53:51 INFO - 'sessionrestore', 04:53:51 INFO - 'sessionrestore_no_auto_restore']}, 04:53:51 INFO - 'other_l64': {'tests': ['a11yr', 04:53:51 INFO - 'ts_paint', 04:53:51 INFO - 'tpaint', 04:53:51 INFO - 'sessionrestore', 04:53:51 INFO - 'sessionrestore_no_auto_restore']}, 04:53:51 INFO - 'other_nol64': {'tests': ['a11yr', 04:53:51 INFO - 'ts_paint', 04:53:51 INFO - 'tpaint', 04:53:51 INFO - 'sessionrestore', 04:53:51 INFO - 'sessionrestore_no_auto_restore']}, 04:53:51 INFO - 'svgr': {'tests': ['tsvgx', 04:53:51 INFO - 'tsvgr_opacity', 04:53:51 INFO - 'tart', 04:53:51 INFO - 'tscrollx', 04:53:51 INFO - 'cart']}, 04:53:51 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 04:53:51 INFO - 'tests': ['tsvgx', 04:53:51 INFO - 'tsvgr_opacity', 04:53:51 INFO - 'tart', 04:53:51 INFO - 'tscrollx', 04:53:51 INFO - 'cart']}, 04:53:51 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:53:51 INFO - 'tests': ['tp5o']}, 04:53:51 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:53:51 INFO - 'talos_options': ['--e10s'], 04:53:51 INFO - 'tests': ['tp5o']}, 04:53:51 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:53:51 INFO - 'talos_options': ['--xperf_path', 04:53:51 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:53:51 INFO - 'tests': ['tp5n']}, 04:53:51 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:53:51 INFO - 'talos_options': ['--e10s', 04:53:51 INFO - '--xperf_path', 04:53:51 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:53:51 INFO - 'tests': ['tp5n']}}, 04:53:51 INFO - 'talos.zip': {'path': '', 04:53:51 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:53:51 INFO - Running post-action listener: _resource_record_post_action 04:53:51 INFO - ##### 04:53:51 INFO - ##### Running create-virtualenv step. 04:53:51 INFO - ##### 04:53:51 INFO - Running pre-action listener: _resource_record_pre_action 04:53:51 INFO - Running main action method: create_virtualenv 04:53:51 INFO - Creating virtualenv /builds/slave/test/build/venv 04:53:51 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 04:53:51 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:53:51 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:53:51 INFO - Using real prefix '/usr' 04:53:51 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:53:52 INFO - Installing distribute.............................................................................................................................................................................................done. 04:53:53 INFO - Installing pip.................done. 04:53:54 INFO - Return code: 0 04:53:54 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:53: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')]} 04:53:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53: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')]} 04:53:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53: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', '--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 0x7fbe071c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe3d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xecc0b0>, '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 0xeccfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xecd440>, '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': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', '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 04:53:54 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 04:53:54 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 04:53:54 INFO - Using env: {'DISPLAY': ':0', 04:53:54 INFO - 'HOME': '/home/cltbld', 04:53:54 INFO - 'LANG': 'en_US.UTF-8', 04:53:54 INFO - 'LANGUAGE': 'en_US:en', 04:53:54 INFO - 'LOGNAME': 'cltbld', 04:53:54 INFO - 'MAIL': '/var/mail/cltbld', 04:53:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:54 INFO - 'MOZ_NO_REMOTE': '1', 04:53:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:54 INFO - 'NO_EM_RESTART': '1', 04:53:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:54 INFO - 'PWD': '/builds/slave/test', 04:53:54 INFO - 'SHELL': '/bin/bash', 04:53:54 INFO - 'SHLVL': '1', 04:53:54 INFO - 'TERM': 'linux', 04:53:54 INFO - 'TMOUT': '86400', 04:53:54 INFO - 'USER': 'cltbld', 04:53:54 INFO - 'XDG_SESSION_COOKIE': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', 04:53:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:54 INFO - '_': '/tools/buildbot/bin/python'} 04:53:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:54 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 04:53:54 INFO - Cleaning up... 04:53:54 INFO - Return code: 0 04:53:54 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 04:53: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')]} 04:53:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53: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')]} 04:53:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53: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', '--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 0x7fbe071c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe3d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xecc0b0>, '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 0xeccfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xecd440>, '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': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', '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 04:53:54 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 04:53:54 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 04:53:54 INFO - Using env: {'DISPLAY': ':0', 04:53:54 INFO - 'HOME': '/home/cltbld', 04:53:54 INFO - 'LANG': 'en_US.UTF-8', 04:53:54 INFO - 'LANGUAGE': 'en_US:en', 04:53:54 INFO - 'LOGNAME': 'cltbld', 04:53:54 INFO - 'MAIL': '/var/mail/cltbld', 04:53:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:54 INFO - 'MOZ_NO_REMOTE': '1', 04:53:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:54 INFO - 'NO_EM_RESTART': '1', 04:53:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:54 INFO - 'PWD': '/builds/slave/test', 04:53:54 INFO - 'SHELL': '/bin/bash', 04:53:54 INFO - 'SHLVL': '1', 04:53:54 INFO - 'TERM': 'linux', 04:53:54 INFO - 'TMOUT': '86400', 04:53:54 INFO - 'USER': 'cltbld', 04:53:54 INFO - 'XDG_SESSION_COOKIE': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', 04:53:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:54 INFO - '_': '/tools/buildbot/bin/python'} 04:53:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:54 INFO - Downloading/unpacking psutil>=0.7.1 04:53:54 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 04:53:54 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 04:53:54 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 04:53:54 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 04:53:54 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 04:53:54 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 04:53:56 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 04:53:56 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 04:53:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:53:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:53:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:53:56 INFO - Installing collected packages: psutil 04:53:56 INFO - Running setup.py install for psutil 04:53:56 INFO - building 'psutil._psutil_linux' extension 04:53:56 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 04:53:56 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 04:53:56 INFO - building 'psutil._psutil_posix' extension 04:53:56 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 04:53:56 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 04:53:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:53:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:53:56 INFO - Successfully installed psutil 04:53:56 INFO - Cleaning up... 04:53:56 INFO - Return code: 0 04:53:56 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 04:53:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:53:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:53:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:56 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 0x7fbe071c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe3d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xecc0b0>, '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 0xeccfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xecd440>, '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': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', '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 04:53:56 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 04:53:56 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 04:53:56 INFO - Using env: {'DISPLAY': ':0', 04:53:56 INFO - 'HOME': '/home/cltbld', 04:53:56 INFO - 'LANG': 'en_US.UTF-8', 04:53:56 INFO - 'LANGUAGE': 'en_US:en', 04:53:56 INFO - 'LOGNAME': 'cltbld', 04:53:56 INFO - 'MAIL': '/var/mail/cltbld', 04:53:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:56 INFO - 'MOZ_NO_REMOTE': '1', 04:53:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:56 INFO - 'NO_EM_RESTART': '1', 04:53:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:56 INFO - 'PWD': '/builds/slave/test', 04:53:56 INFO - 'SHELL': '/bin/bash', 04:53:56 INFO - 'SHLVL': '1', 04:53:56 INFO - 'TERM': 'linux', 04:53:56 INFO - 'TMOUT': '86400', 04:53:56 INFO - 'USER': 'cltbld', 04:53:56 INFO - 'XDG_SESSION_COOKIE': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', 04:53:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:56 INFO - '_': '/tools/buildbot/bin/python'} 04:53:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:56 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 04:53:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:58 INFO - Downloading mozsystemmonitor-0.0.tar.gz 04:53:58 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 04:53:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:53:58 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 04:53:58 INFO - Installing collected packages: mozsystemmonitor 04:53:58 INFO - Running setup.py install for mozsystemmonitor 04:53:58 INFO - Successfully installed mozsystemmonitor 04:53:58 INFO - Cleaning up... 04:53:58 INFO - Return code: 0 04:53:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:53:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:53:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:53:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:58 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 0x7fbe071c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe3d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xecc0b0>, '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 0xeccfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xecd440>, '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': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', '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 04:53:58 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 04:53:58 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 04:53:58 INFO - Using env: {'DISPLAY': ':0', 04:53:58 INFO - 'HOME': '/home/cltbld', 04:53:58 INFO - 'LANG': 'en_US.UTF-8', 04:53:58 INFO - 'LANGUAGE': 'en_US:en', 04:53:58 INFO - 'LOGNAME': 'cltbld', 04:53:58 INFO - 'MAIL': '/var/mail/cltbld', 04:53:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:58 INFO - 'MOZ_NO_REMOTE': '1', 04:53:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:58 INFO - 'NO_EM_RESTART': '1', 04:53:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:58 INFO - 'PWD': '/builds/slave/test', 04:53:58 INFO - 'SHELL': '/bin/bash', 04:53:58 INFO - 'SHLVL': '1', 04:53:58 INFO - 'TERM': 'linux', 04:53:58 INFO - 'TMOUT': '86400', 04:53:58 INFO - 'USER': 'cltbld', 04:53:58 INFO - 'XDG_SESSION_COOKIE': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', 04:53:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:58 INFO - '_': '/tools/buildbot/bin/python'} 04:53:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:59 INFO - Downloading/unpacking blobuploader==1.2.4 04:53:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:00 INFO - Downloading blobuploader-1.2.4.tar.gz 04:54:00 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 04:54:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:54:00 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:54:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:01 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 04:54:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:54:01 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:54:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:01 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:01 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:01 INFO - Downloading docopt-0.6.1.tar.gz 04:54:01 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 04:54:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:54:01 INFO - Installing collected packages: blobuploader, requests, docopt 04:54:01 INFO - Running setup.py install for blobuploader 04:54:01 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:54:01 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:54:01 INFO - Running setup.py install for requests 04:54:01 INFO - Running setup.py install for docopt 04:54:02 INFO - Successfully installed blobuploader requests docopt 04:54:02 INFO - Cleaning up... 04:54:02 INFO - Return code: 0 04:54:02 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:54:02 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')]} 04:54:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:54:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:54:02 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')]} 04:54:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:54:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:54:02 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 0x7fbe071c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe3d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xecc0b0>, '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 0xeccfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xecd440>, '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': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', '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 04:54:02 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 04:54:02 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 04:54:02 INFO - Using env: {'DISPLAY': ':0', 04:54:02 INFO - 'HOME': '/home/cltbld', 04:54:02 INFO - 'LANG': 'en_US.UTF-8', 04:54:02 INFO - 'LANGUAGE': 'en_US:en', 04:54:02 INFO - 'LOGNAME': 'cltbld', 04:54:02 INFO - 'MAIL': '/var/mail/cltbld', 04:54:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:54:02 INFO - 'MOZ_NO_REMOTE': '1', 04:54:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:54:02 INFO - 'NO_EM_RESTART': '1', 04:54:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:54:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:54:02 INFO - 'PWD': '/builds/slave/test', 04:54:02 INFO - 'SHELL': '/bin/bash', 04:54:02 INFO - 'SHLVL': '1', 04:54:02 INFO - 'TERM': 'linux', 04:54:02 INFO - 'TMOUT': '86400', 04:54:02 INFO - 'USER': 'cltbld', 04:54:02 INFO - 'XDG_SESSION_COOKIE': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', 04:54:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:54:02 INFO - '_': '/tools/buildbot/bin/python'} 04:54:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:54:02 INFO - Running setup.py (path:/tmp/pip-v_o_ok-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:54:02 INFO - Running setup.py (path:/tmp/pip-C46edJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:54:02 INFO - Running setup.py (path:/tmp/pip-yg6Y1F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:54:02 INFO - Running setup.py (path:/tmp/pip-s2tVRz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:54:02 INFO - Running setup.py (path:/tmp/pip-V6X2al-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:54:02 INFO - Running setup.py (path:/tmp/pip-fWIUMw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:54:02 INFO - Running setup.py (path:/tmp/pip-KtmRfb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:54:02 INFO - Running setup.py (path:/tmp/pip-8rsUcC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:54:02 INFO - Running setup.py (path:/tmp/pip-Jx8JP7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:54:02 INFO - Running setup.py (path:/tmp/pip-FyhVJa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:54:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:54:02 INFO - Running setup.py (path:/tmp/pip-2Xzqgh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:54:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:54:03 INFO - Running setup.py (path:/tmp/pip-48uDA7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:54:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:54:03 INFO - Running setup.py (path:/tmp/pip-ey5MPy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:54:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:54:03 INFO - Running setup.py (path:/tmp/pip-HKAVxd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:54:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:54:03 INFO - Running setup.py (path:/tmp/pip-LpLf0Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:54:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:54:03 INFO - Running setup.py (path:/tmp/pip-hJ9nTb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:54:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:54:03 INFO - Running setup.py (path:/tmp/pip-75W9c4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:54:03 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:54:03 INFO - Running setup.py install for manifestparser 04:54:03 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:54:03 INFO - Running setup.py install for mozcrash 04:54:03 INFO - Running setup.py install for mozdebug 04:54:03 INFO - Running setup.py install for mozdevice 04:54:03 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:54:03 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:54:03 INFO - Running setup.py install for mozfile 04:54:04 INFO - Running setup.py install for mozhttpd 04:54:04 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Running setup.py install for mozinfo 04:54:04 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Running setup.py install for mozInstall 04:54:04 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Running setup.py install for mozleak 04:54:04 INFO - Running setup.py install for mozlog 04:54:04 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Running setup.py install for moznetwork 04:54:04 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Running setup.py install for mozprocess 04:54:04 INFO - Running setup.py install for mozprofile 04:54:04 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Running setup.py install for mozrunner 04:54:04 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:54:04 INFO - Running setup.py install for mozscreenshot 04:54:05 INFO - Running setup.py install for moztest 04:54:05 INFO - Running setup.py install for mozversion 04:54:05 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:54:05 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:54:05 INFO - Cleaning up... 04:54:05 INFO - Return code: 0 04:54:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:54:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:54:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:54:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:54:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:54:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:54:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:54:05 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 0x7fbe071c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe3d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xecc0b0>, '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 0xeccfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xecd440>, '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': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', '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 04:54:05 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 04:54:05 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 04:54:05 INFO - Using env: {'DISPLAY': ':0', 04:54:05 INFO - 'HOME': '/home/cltbld', 04:54:05 INFO - 'LANG': 'en_US.UTF-8', 04:54:05 INFO - 'LANGUAGE': 'en_US:en', 04:54:05 INFO - 'LOGNAME': 'cltbld', 04:54:05 INFO - 'MAIL': '/var/mail/cltbld', 04:54:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:54:05 INFO - 'MOZ_NO_REMOTE': '1', 04:54:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:54:05 INFO - 'NO_EM_RESTART': '1', 04:54:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:54:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:54:05 INFO - 'PWD': '/builds/slave/test', 04:54:05 INFO - 'SHELL': '/bin/bash', 04:54:05 INFO - 'SHLVL': '1', 04:54:05 INFO - 'TERM': 'linux', 04:54:05 INFO - 'TMOUT': '86400', 04:54:05 INFO - 'USER': 'cltbld', 04:54:05 INFO - 'XDG_SESSION_COOKIE': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', 04:54:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:54:05 INFO - '_': '/tools/buildbot/bin/python'} 04:54:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:54:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:54:05 INFO - Running setup.py (path:/tmp/pip-pUS8S_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:54:05 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)) 04:54:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:54:05 INFO - Running setup.py (path:/tmp/pip-U1U8Ff-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:54:05 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)) 04:54:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:54:05 INFO - Running setup.py (path:/tmp/pip-B1ZSQb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:54:05 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)) 04:54:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:54:05 INFO - Running setup.py (path:/tmp/pip-FJOY7Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:54:05 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)) 04:54:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:54:05 INFO - Running setup.py (path:/tmp/pip-UMZEIb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:54:05 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)) 04:54:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:54:05 INFO - Running setup.py (path:/tmp/pip-Oed5ik-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:54:05 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)) 04:54:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:54:05 INFO - Running setup.py (path:/tmp/pip-8L0AV_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:54:05 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)) 04:54:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:54:05 INFO - Running setup.py (path:/tmp/pip-2YFcYD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:54:06 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)) 04:54:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:54:06 INFO - Running setup.py (path:/tmp/pip-SyORX8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:54:06 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)) 04:54:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:54:06 INFO - Running setup.py (path:/tmp/pip-giIWSO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:54:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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)) 04:54:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:54:06 INFO - Running setup.py (path:/tmp/pip-d1U783-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:54:06 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)) 04:54:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:54:06 INFO - Running setup.py (path:/tmp/pip-mJlbnx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:54:06 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)) 04:54:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:54:06 INFO - Running setup.py (path:/tmp/pip-lBXltj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:54:06 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)) 04:54:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:54:06 INFO - Running setup.py (path:/tmp/pip-nVA25H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:54:06 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)) 04:54:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:54:06 INFO - Running setup.py (path:/tmp/pip-I0XNVA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:54:06 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)) 04:54:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:54:06 INFO - Running setup.py (path:/tmp/pip-V4N2iH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:54:06 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)) 04:54:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:54:06 INFO - Running setup.py (path:/tmp/pip-S_FAqc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:54:06 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)) 04:54:06 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)) 04:54:06 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)) 04:54:06 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)) 04:54:06 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)) 04:54:06 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)) 04:54:06 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:54:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:08 INFO - Downloading blessings-1.5.1.tar.gz 04:54:08 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 04:54:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:54:08 INFO - Installing collected packages: blessings 04:54:08 INFO - Running setup.py install for blessings 04:54:08 INFO - Successfully installed blessings 04:54:08 INFO - Cleaning up... 04:54:08 INFO - Return code: 0 04:54:08 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:54:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:54:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:54:08 INFO - Reading from file tmpfile_stdout 04:54:08 INFO - Current package versions: 04:54:08 INFO - argparse == 1.2.1 04:54:08 INFO - blessings == 1.5.1 04:54:08 INFO - blobuploader == 1.2.4 04:54:08 INFO - docopt == 0.6.1 04:54:08 INFO - manifestparser == 1.1 04:54:08 INFO - mozInstall == 1.12 04:54:08 INFO - mozcrash == 0.16 04:54:08 INFO - mozdebug == 0.1 04:54:08 INFO - mozdevice == 0.47 04:54:08 INFO - mozfile == 1.2 04:54:08 INFO - mozhttpd == 0.7 04:54:08 INFO - mozinfo == 0.9 04:54:08 INFO - mozleak == 0.1 04:54:08 INFO - mozlog == 3.1 04:54:08 INFO - moznetwork == 0.27 04:54:08 INFO - mozprocess == 0.22 04:54:08 INFO - mozprofile == 0.27 04:54:08 INFO - mozrunner == 6.11 04:54:08 INFO - mozscreenshot == 0.1 04:54:08 INFO - mozsystemmonitor == 0.0 04:54:08 INFO - moztest == 0.7 04:54:08 INFO - mozversion == 1.4 04:54:08 INFO - psutil == 3.1.1 04:54:08 INFO - requests == 1.2.3 04:54:08 INFO - wsgiref == 0.1.2 04:54:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:54:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:54:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:54:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:54:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:54:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:54:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:54:08 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 0x7fbe071c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe3d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xecc0b0>, '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 0xeccfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xecd440>, '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': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', '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 04:54:08 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 04:54:08 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 04:54:08 INFO - Using env: {'DISPLAY': ':0', 04:54:08 INFO - 'HOME': '/home/cltbld', 04:54:08 INFO - 'LANG': 'en_US.UTF-8', 04:54:08 INFO - 'LANGUAGE': 'en_US:en', 04:54:08 INFO - 'LOGNAME': 'cltbld', 04:54:08 INFO - 'MAIL': '/var/mail/cltbld', 04:54:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:54:08 INFO - 'MOZ_NO_REMOTE': '1', 04:54:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:54:08 INFO - 'NO_EM_RESTART': '1', 04:54:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:54:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:54:08 INFO - 'PWD': '/builds/slave/test', 04:54:08 INFO - 'SHELL': '/bin/bash', 04:54:08 INFO - 'SHLVL': '1', 04:54:08 INFO - 'TERM': 'linux', 04:54:08 INFO - 'TMOUT': '86400', 04:54:08 INFO - 'USER': 'cltbld', 04:54:08 INFO - 'XDG_SESSION_COOKIE': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', 04:54:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:54:08 INFO - '_': '/tools/buildbot/bin/python'} 04:54:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:54:09 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)) 04:54:09 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)) 04:54:09 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)) 04:54:09 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)) 04:54:09 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)) 04:54:09 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)) 04:54:09 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)) 04:54:09 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)) 04:54:09 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)) 04:54:09 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)) 04:54:09 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)) 04:54:09 INFO - Cleaning up... 04:54:09 INFO - Return code: 0 04:54:09 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:54: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')]} 04:54:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:54:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:54: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')]} 04:54:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:54:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:54:09 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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe071c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe3d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xecc0b0>, '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 0xeccfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xecd440>, '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': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', '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 04:54:09 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', 'jsonschema'] in /builds/slave/test/build 04:54:09 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 jsonschema 04:54:09 INFO - Using env: {'DISPLAY': ':0', 04:54:09 INFO - 'HOME': '/home/cltbld', 04:54:09 INFO - 'LANG': 'en_US.UTF-8', 04:54:09 INFO - 'LANGUAGE': 'en_US:en', 04:54:09 INFO - 'LOGNAME': 'cltbld', 04:54:09 INFO - 'MAIL': '/var/mail/cltbld', 04:54:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:54:09 INFO - 'MOZ_NO_REMOTE': '1', 04:54:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:54:09 INFO - 'NO_EM_RESTART': '1', 04:54:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:54:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:54:09 INFO - 'PWD': '/builds/slave/test', 04:54:09 INFO - 'SHELL': '/bin/bash', 04:54:09 INFO - 'SHLVL': '1', 04:54:09 INFO - 'TERM': 'linux', 04:54:09 INFO - 'TMOUT': '86400', 04:54:09 INFO - 'USER': 'cltbld', 04:54:09 INFO - 'XDG_SESSION_COOKIE': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', 04:54:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:54:09 INFO - '_': '/tools/buildbot/bin/python'} 04:54:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:54:09 INFO - Downloading/unpacking jsonschema 04:54:09 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 04:54:09 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 04:54:09 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 04:54:09 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 04:54:09 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 04:54:09 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 04:54:10 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:54:10 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 04:54:10 INFO - Downloading/unpacking functools32 (from jsonschema) 04:54:10 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 04:54:10 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 04:54:10 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 04:54:10 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 04:54:10 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 04:54:10 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 04:54:11 INFO - Downloading functools32-3.2.3-2.tar.gz 04:54:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 04:54:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:54:11 INFO - warning: no files found matching '*.txt' 04:54:11 INFO - no previously-included directories found matching 'build' 04:54:11 INFO - no previously-included directories found matching 'dist' 04:54:11 INFO - no previously-included directories found matching '.git*' 04:54:11 INFO - Installing collected packages: jsonschema, functools32 04:54:11 INFO - Running setup.py install for functools32 04:54:11 INFO - warning: no files found matching '*.txt' 04:54:11 INFO - no previously-included directories found matching 'build' 04:54:11 INFO - no previously-included directories found matching 'dist' 04:54:11 INFO - no previously-included directories found matching '.git*' 04:54:11 INFO - Successfully installed jsonschema functools32 04:54:11 INFO - Cleaning up... 04:54:11 INFO - Return code: 0 04:54:11 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 04:54:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:54:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:54:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:54:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:54:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:54:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:54:11 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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbe071c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe3d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xecc0b0>, '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 0xeccfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xecd440>, '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': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', '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 04:54:11 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', 'flake8'] in /builds/slave/test/build 04:54:11 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 flake8 04:54:11 INFO - Using env: {'DISPLAY': ':0', 04:54:11 INFO - 'HOME': '/home/cltbld', 04:54:11 INFO - 'LANG': 'en_US.UTF-8', 04:54:11 INFO - 'LANGUAGE': 'en_US:en', 04:54:11 INFO - 'LOGNAME': 'cltbld', 04:54:11 INFO - 'MAIL': '/var/mail/cltbld', 04:54:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:54:11 INFO - 'MOZ_NO_REMOTE': '1', 04:54:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:54:11 INFO - 'NO_EM_RESTART': '1', 04:54:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:54:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:54:11 INFO - 'PWD': '/builds/slave/test', 04:54:11 INFO - 'SHELL': '/bin/bash', 04:54:11 INFO - 'SHLVL': '1', 04:54:11 INFO - 'TERM': 'linux', 04:54:11 INFO - 'TMOUT': '86400', 04:54:11 INFO - 'USER': 'cltbld', 04:54:11 INFO - 'XDG_SESSION_COOKIE': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', 04:54:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:54:11 INFO - '_': '/tools/buildbot/bin/python'} 04:54:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:54:11 INFO - Downloading/unpacking flake8 04:54:11 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 04:54:11 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 04:54:11 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 04:54:11 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 04:54:11 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 04:54:11 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 04:54:13 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:54:13 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 04:54:13 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:13 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:54:13 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 04:54:13 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:13 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 04:54:13 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:54:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:54:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:54:13 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 04:54:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 04:54:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:54:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:54:13 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:54:13 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:54:13 INFO - no previously-included directories found matching 'docs/_build' 04:54:13 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:54:14 INFO - Running setup.py install for pep8 04:54:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:54:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:54:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:54:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:54:14 INFO - no previously-included directories found matching 'docs/_build' 04:54:14 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 04:54:14 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:54:14 INFO - Cleaning up... 04:54:14 INFO - Return code: 0 04:54:14 INFO - Running post-action listener: _resource_record_post_action 04:54:14 INFO - Running post-action listener: _start_resource_monitoring 04:54:14 INFO - Starting resource monitoring. 04:54:14 INFO - ##### 04:54:14 INFO - ##### Running install step. 04:54:14 INFO - ##### 04:54:14 INFO - Running pre-action listener: _resource_record_pre_action 04:54:14 INFO - Running main action method: install 04:54:14 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:54:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:54:14 INFO - Reading from file tmpfile_stdout 04:54:14 INFO - Detecting whether we're running mozinstall >=1.0... 04:54:14 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:54:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:54:14 INFO - Reading from file tmpfile_stdout 04:54:14 INFO - Output received: 04:54:14 INFO - Usage: mozinstall [options] installer 04:54:14 INFO - Options: 04:54:14 INFO - -h, --help show this help message and exit 04:54:14 INFO - -d DEST, --destination=DEST 04:54:14 INFO - Directory to install application into. [default: 04:54:14 INFO - "/builds/slave/test"] 04:54:14 INFO - --app=APP Application being installed. [default: firefox] 04:54:14 INFO - mkdir: /builds/slave/test/build/application 04:54:14 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'] 04:54:14 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 04:54:29 INFO - Reading from file tmpfile_stdout 04:54:29 INFO - Output received: 04:54:29 INFO - /builds/slave/test/build/application/firefox/firefox 04:54:29 INFO - Running post-action listener: _resource_record_post_action 04:54:29 INFO - ##### 04:54:29 INFO - ##### Running run-tests step. 04:54:29 INFO - ##### 04:54:29 INFO - Running pre-action listener: _resource_record_pre_action 04:54:29 INFO - Running main action method: run_tests 04:54:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:54:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:54:29 INFO - Python 2.7.3 04:54:29 INFO - Return code: 0 04:54:29 INFO - grabbing minidump binary from tooltool 04:54: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')]} 04:54:29 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 0xecc0b0>, '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 0xeccfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xecd440>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:54:29 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 04:54:29 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 04:54:29 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:54:29 INFO - Return code: 0 04:54:29 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:54:29 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:54:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:54:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:54:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:54:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 04:54:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 04:54:30 INFO - Return code: 0 04:54:30 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/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--webServer', 'localhost'] in /builds/slave/test/build 04:54:30 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/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-045 --webServer localhost 04:54:30 INFO - Using env: {'DISPLAY': ':0', 04:54:30 INFO - 'HOME': '/home/cltbld', 04:54:30 INFO - 'LANG': 'en_US.UTF-8', 04:54:30 INFO - 'LANGUAGE': 'en_US:en', 04:54:30 INFO - 'LOGNAME': 'cltbld', 04:54:30 INFO - 'MAIL': '/var/mail/cltbld', 04:54:30 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:54:30 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:54:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:54:30 INFO - 'MOZ_NO_REMOTE': '1', 04:54:30 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:54:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:54:30 INFO - 'NO_EM_RESTART': '1', 04:54:30 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:54:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:54:30 INFO - 'PWD': '/builds/slave/test', 04:54:30 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:54:30 INFO - 'SHELL': '/bin/bash', 04:54:30 INFO - 'SHLVL': '1', 04:54:30 INFO - 'TERM': 'linux', 04:54:30 INFO - 'TMOUT': '86400', 04:54:30 INFO - 'USER': 'cltbld', 04:54:30 INFO - 'XDG_SESSION_COOKIE': '61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217', 04:54:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:54:30 INFO - '_': '/tools/buildbot/bin/python'} 04:54:30 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/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--webServer', 'localhost'] with output_timeout 3600 04:54:30 INFO - mozversion INFO | application_buildid: 20151210034541 04:54:30 INFO - mozversion INFO | application_changeset: c25d5a6ca04d3f4d1625190ccebf5cf58845927c 04:54:30 INFO - mozversion INFO | application_display_name: Nightly 04:54:30 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:54:30 INFO - mozversion INFO | application_name: Firefox 04:54:30 INFO - mozversion INFO | application_remotingname: firefox 04:54:30 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/b2g-inbound 04:54:30 INFO - mozversion INFO | application_vendor: Mozilla 04:54:30 INFO - mozversion INFO | application_version: 45.0a1 04:54:30 INFO - mozversion INFO | platform_buildid: 20151210034541 04:54:30 INFO - mozversion INFO | platform_changeset: c25d5a6ca04d3f4d1625190ccebf5cf58845927c 04:54:30 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/b2g-inbound 04:54:30 INFO - mozversion INFO | platform_version: 45.0a1 04:54:30 INFO - 2015-12-10 04:54:30,224 DEBUG : using testdate: 1449752070 04:54:30 INFO - 2015-12-10 04:54:30,224 DEBUG : actual date: 1449752070 04:54:30 INFO - 2015-12-10 04:54:30,232 INFO : starting webserver on 'localhost:38407' 04:54:30 INFO - 2015-12-10 04:54:30,233 INFO : Starting test suite talos-linux64-ix-045 04:54:30 INFO - 2015-12-10 04:54:30,233 INFO : Starting test dromaeo_css 04:54:30 INFO - 2015-12-10 04:54:30,233 DEBUG : operating with platform_type : linux_ 04:54:30 INFO - 2015-12-10 04:54:30,234 INFO : Initialising browser for dromaeo_css test... 04:54:30 INFO - 2015-12-10 04:54:30,248 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpz45XD4/profile http://localhost:38407/getInfo.html 04:54:34 INFO - 2015-12-10 04:54:34,746 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 04:54:34 INFO - 2015-12-10 04:54:34,746 DEBUG : BROWSER_OUTPUT: colorDepth:24 04:54:34 INFO - 2015-12-10 04:54:34,746 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 04:54:34 INFO - 2015-12-10 04:54:34,746 DEBUG : BROWSER_OUTPUT: __metrics 04:54:34 INFO - 2015-12-10 04:54:34,843 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 04:54:34 INFO - 2015-12-10 04:54:34,911 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:54:35 INFO - 2015-12-10 04:54:35,818 INFO : Browser initialized. 04:54:35 INFO - 2015-12-10 04:54:35,819 INFO : Running cycle 1/1 for dromaeo_css test... 04:54:35 INFO - 2015-12-10 04:54:35,819 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpz45XD4/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 04:54:47 INFO - 2015-12-10 04:54:47,836 DEBUG : BROWSER_OUTPUT: RSS: Main: 142409728 04:54:47 INFO - 2015-12-10 04:54:47,836 DEBUG : BROWSER_OUTPUT: 04:55:39 INFO - 2015-12-10 04:55:39,152 DEBUG : BROWSER_OUTPUT: 1449752139149 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] 04:57:51 INFO - 2015-12-10 04:57:51,099 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/dromaeo/cssquery-dojo.html (next: http://localhost:38407/tests/dromaeo/cssquery-ext.html) 04:57:52 INFO - 2015-12-10 04:57:52,184 DEBUG : BROWSER_OUTPUT: RSS: Main: 249073664 04:57:52 INFO - 2015-12-10 04:57:52,184 DEBUG : BROWSER_OUTPUT: 05:00:54 INFO - 2015-12-10 05:00:54,627 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/dromaeo/cssquery-ext.html (next: http://localhost:38407/tests/dromaeo/cssquery-jquery.html) 05:00:55 INFO - 2015-12-10 05:00:55,200 DEBUG : BROWSER_OUTPUT: RSS: Main: 218464256 05:00:55 INFO - 2015-12-10 05:00:55,201 DEBUG : BROWSER_OUTPUT: 05:03:57 INFO - 2015-12-10 05:03:57,230 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/dromaeo/cssquery-jquery.html (next: http://localhost:38407/tests/dromaeo/cssquery-mootools.html) 05:03:57 INFO - 2015-12-10 05:03:57,803 DEBUG : BROWSER_OUTPUT: RSS: Main: 219238400 05:03:57 INFO - 2015-12-10 05:03:57,803 DEBUG : BROWSER_OUTPUT: 05:06:59 INFO - 2015-12-10 05:06:59,734 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/dromaeo/cssquery-mootools.html (next: http://localhost:38407/tests/dromaeo/cssquery-prototype.html) 05:07:00 INFO - 2015-12-10 05:07:00,307 DEBUG : BROWSER_OUTPUT: RSS: Main: 206733312 05:07:00 INFO - 2015-12-10 05:07:00,307 DEBUG : BROWSER_OUTPUT: 05:10:03 INFO - 2015-12-10 05:10:03,043 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/dromaeo/cssquery-prototype.html (next: http://localhost:38407/tests/dromaeo/cssquery-yui.html) 05:10:03 INFO - 2015-12-10 05:10:03,653 DEBUG : BROWSER_OUTPUT: RSS: Main: 210604032 05:10:03 INFO - 2015-12-10 05:10:03,653 DEBUG : BROWSER_OUTPUT: 05:13:06 INFO - 2015-12-10 05:13:06,284 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/dromaeo/cssquery-yui.html (next: http://localhost:38407/tests/dromaeo/cssquery-dojo.html) 05:13:06 INFO - 2015-12-10 05:13:06,530 DEBUG : BROWSER_OUTPUT: RSS: Main: 255700992 05:13:06 INFO - 2015-12-10 05:13:06,530 DEBUG : BROWSER_OUTPUT: 05:13:06 INFO - 2015-12-10 05:13:06,532 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:13:06 INFO - 2015-12-10 05:13:06,532 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:13:06 INFO - 2015-12-10 05:13:06,532 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:13:06 INFO - 2015-12-10 05:13:06,532 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:13:06 INFO - 2015-12-10 05:13:06,536 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2626.7635912767846;2687;2692.259628602133;2703.405250844815;2726.986365068175;4575.062112266985;4677.649176311777;4686.156491831469;4698.036902435001;4724.031573527427;4574.885627859305;4638.373819534362;4689.788959496822;4711.387519622444;4726.952730472694;4292.570742925714;4293.8711838644895;4304.9139017219795;4309.913801723964;4343.826246950118;4158.896027599304;4405.625521830648;4416.823327066913;4465.419495465601;4465.82136714531;4180.979095104505;4240.872773816791;4263.786810659454;4273.807678654468;4274.700770946035;4221.725587836811;4269.146170765828;4271.658267338606;4316.136772645452;4316.56834316569;4129.070959034223;4255.4255175551525;4259.872203833859;4284.378765079046;4312.331588603772;4411.029573493858;4471.552844715535;4490.955090449086;4540.114677637862;4570.748608826513;5027.195648696227;5053.317802096707;5055.721935293557;5089.262057001714;5100.311457953166;4814.205656066745;5065.366829146356;5068.087744206042;5080.923786143211;5083.8983220335385;4546.65900057497;4583.175028494869;4597.563231493003;4604.102200070987;4644.86065418038;5116.667416617908;5122.718250496258;5158.200478925773;5179.352580927384;5182.170852663556;4665.323528088408;4917.975410122926;4918.11473934688;4927.359443272351;4946.975265123651;4862.294967229732;4889.877753056202;4900.215965445512;4949.554540091409;5018.5232402921665;4918.385201849769;4920.876978075506;4925.261210818334;4935.383077115361;4974.403071631427;4720.598749106296;4913.48408417111;4916.459189489225;4919.3604831371695;4964.627652926045;4063.5326937401987;4076.4700588923843;4081.3673880548563;4085.162541678949;4145.108801607669;3611.656892595199;3633.073566240592;3642.7996460194413;3670.981645091811;3672.706183505313;4354;4370.847020354272;4371.606555409965;4374.650027997753;4412.646988240933;4809.44691360498;4900.215965445512;4901.019796040806;4907.656464047483;5022.573081288131;4306.612404883575;4313.245182093184;4329.242382583036;4329.264025115738;4350.847720329773;4368.060866913629;4369.584889435499;4408.977955110204;4413.007073408522;4451.666125040635;4594.793234304398;4711.340412342206;4711.764411779329;4778.880527986758;4826.855194344175;4869.634777391639;4915.877103072452;4934.358533390637;4934.8766280843265;4973.378327709036;4795.688280261772;4798.856034318976;4800.087983283165;4801.039792041536;4844.394450693663;4792.95207047925;4897.118518666532;4902.093112774148;4952.1581331173065;5001.824936127218;4876.390451193601;4909.950900491092;4932.136876046606;4942.382202224722;4969.751512424436;4805.255185446262;4806.990531988322;4807.591354734886;4836.637252206028;4846.151923413459;4672.906541869212;4768.094062128184;4769.66612337133;4798.5441383068555;4847.781849816696;4702.294655801657;4783.808647654055;4802.039592081667;4803.087413391444;4854.660173787801;4965.4289756677;4968.403791545038;4971.950280497149;4996.475370086088;5005.599552035901;4518.051209246095;4574.88562785933;4606.286025666027;4845.248986407112;4848.369711937426 05:13:06 INFO - 2015-12-10 05:13:06,536 DEBUG : BROWSER_OUTPUT: |1;ext.html;565.9547236221102;570.8572856785801;576.2249774053898;577.2668710737366;577.2956992469188;27268.590971135425;27814;27841.164765057056;27844;35797;40766.18467630645;41377.7931110344;41413.58586414135;41414.37878431826;41420;7913.327367173797;8089.271965523102;8090.433669643127;8090.433669643127;8101.716439924604;7113.786586402416;7252.818679533001;7257.056582644249;7259.782206533812;7882.60586970652;7044.366007059363;7141.89287160693;9996.90003099967;10162.39025658463;10166.881643019262;9806.705798826011;9905.405675659411;9913.702588922344;9916.900830991706;9918.752031199278;7142.21435642079;9729.464879431629;9857.35927164732;9866.950665246699;9870.703878883573;25658;42041;42854.78572607148;43011.1397772046;43053.138937221396;2648.0864101884818;2684.476527077221;2890.956635650446;3576.6423357664025;3659.396199627058;25256.621150682753;26202.73797262022;27074.458510829674;27240;27620.171394858186;3406.744494162948;3414.931701365959;3418.316336732639;3423.4351332030433;3472.5659292588425;178280;178550;180002;180669;180877;52376.47623523716;52599;52630.999999999236;52683.209751853756;52742;55733.721331393084;55971.72014139903;55998;56173.71913140408;56200;14176.149431033964;14615.196164210858;14625;14625.195614241318;14639.634009149857;10876.12990960737;10957.890421095686;10958.178136639784;10977.890221097687;10979.780404392028;19055.230597861097;19497;19502.219911203392;19512.21951121939;19519.90240048819;7001.264867188974;7191.208967013625;7231.74688885897;7262.419006479469;7344.742933997284;795.4074214709963;801.6232370785722;824.517657170562;863.3266052479077;992.6773798515511;26776.59835102475;26916.73083269142;27307.453850923266;27325.726742732317;27347.589786153225;809.6316176139842;847.720252316734;882.4572887674034;921.7326975177124;943.5423819447562;12556.560520381925;12876.484940602271;12959.870401295866;12965.481380744664;13000.284984325765;245792;250328;251591;251820;251897;38632.61367386347;39136.608633913864;44489.11021779611;45054.32418513725;45114;1165.6910918606577;1166.1429497730594;1171.6075114836456;1184.650528094197;1187.5249900040053;23295.650565241875;23516.29451116469;24136.87931560331;24677.38306542351;25872.223833285032;37681.43477847779;37895.24209515849;38116.237675245786;38125.237495249385;38239.61760382361;158657;159311;159314;159362;160026;26574.86712566425;26994;27042.459150817267;27065.45869082647;27088.72911270941;36919;37994.43008354932;40656;41602.1679566413;41701.582984170986;35055.82472087623;35142.64857351496;35262.47106293459;35619.82190089033;36037.45943810792;34225.486617700255;34836.477452837724;34836.65163348334;34844.65155348414;35094.29811403809;34292.314153717285;34772.65227347795;35107.12232194216;35187.82406087953;35254.47118293176;30683.846580766953;31399.529007064455;32047.198820029687;32054;32086.35827283488;24088.638670420307;24406.26781196567;24466.51066978686;24637.753622463544;24648.753512464646 05:13:06 INFO - 2015-12-10 05:13:06,539 DEBUG : BROWSER_OUTPUT: |2;jquery.html;339.3044259268499;339.31119826751694;339.75707369231003;342.38712704259376;343.0976531721572;13356.532521361754;13636.72726545471;14966.17686027268;15178.785697144229;16628.168591570404;9322.580483878224;13175.275359855204;16403.17984100796;16522.917385413086;16535.090570018645;4511.187986162489;4640.489546149921;4644.303354496836;4649.232876575378;4650.604698600606;3503.10670778951;3601.783892966417;4598.057398233354;4623;4624.653151013671;5099.847004589849;5201.375834899817;5233.633645644806;5234.8691282717855;5283.947160528403;4872;5143.305653736754;5163.096458119833;5176;5981.192539007222;5296.126139187029;5302.867428314285;5305.098133317345;5310.946890531084;5325.733713314319;11427.657170284821;11442.942785286103;11445.599404020819;12299.754004919852;19513.9024304879;1715.1424287856073;1752.088913764835;1812.9637407251912;1832.8533717302716;1848.7134494153427;8757;9044.502552359618;9312.83589551306;11137.276077054965;12660.240385576895;1719.5443207550009;1733.514615907548;1752.5443384719938;1772.822717728217;1778.9555261118446;53928.460715392735;57183.42816571823;57325;57445.712771436294;57557.42442575563;9586.281028922858;9731.65939192139;9761.902380976242;9779.755506112404;9831.950840245752;12285.877141228473;12345.876541234473;12352.75294494123;12359;12362.38188090592;6758.8648227036165;6865.588064716133;7126.109236345457;7130.215676275606;7238.312360325761;6231.345708700612;6348.238211414659;6352.491800656029;6352.777652782131;6736.360045795642;3995.92110130269;4011.4183443400543;4023.8189281482405;4126.628603425706;4127.628513433805;1633.1017940132879;1638.4101723379574;1657.9005259684457;1713.811480737118;1780.3590707345345;376.6083273395638;769.1539306762628;796.6454927557181;801.2708435323827;996.292632231124;8601.182887625666;9130.81738365229;9151.816963660689;9467.147956683932;15310;757.1784613694203;782.5695867272977;797.6649807080923;800.083903929997;827.3381294964005;8633.39566230358;8944.68693595721;9049.683261085962;9223.44659320443;9324.440533568008;488840;490000;497356;522013;541350;69365.3063469369;70384.64807675929;71357.64321178464;71955.64022179961;72319;1060.151878497199;1061.1722856172198;1068.7969285835666;1070.1118072000222;1091.49245600796;14502.347394367489;14667.266636667911;14680;14845.183514906785;15137.697246055237;33001.50497742488;33194.33611327712;33709.325813483105;33961;33969.49045764266;42999.57000429956;43959.78020109879;44671.55328446804;45304.54695453135;46021.07957840891;8010.399220058635;8457.40798144124;8467.026291976255;8487.830243395221;8606.139386061344;10048.648297309559;10057.145142662956;10186.388816671024;10188.745281367728;10294.3823370595;11645.41772911368;13390.330483475593;13678.589642310746;13750.449982000608;13975.301234938415;12877.549285774952;13103.737925241632;13111.27887966171;13322.800157997832;13522.053456258362;13521;13547.86452135466;14400.927995359956;14534.92732536373;15106.773398399253;9046.366754327133;9309.789727335674;9332.81334373295;9397.953010234905;9399.201067909304;9622.085901839315;9729.805403892024;12237;12811;13887.958403120008 05:13:06 INFO - 2015-12-10 05:13:06,541 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1217.920835145716;1650.1749125437282;1685.401682402747;1704.411977867636;1736.4009416751223;5849.210356601858;6818.727250909964;6975.4070903973225;7019.6139212343305;7032.12098487689;6834.487413443999;6978.127734033246;7003;7006.229314775371;7008.789736307906;1767.5492749348898;1796.0480945099118;1953.8241558259717;1993.3920154352916;1994.7207390965277;2083.0938541734395;2091.3098677436487;2094.214669498938;2094.539201375695;2095.549456866773;2009.6081264153495;2021.2622392826586;2052.6818343156833;2054.0551346380685;2056.5372791121954;2024.6760518316999;2039.9796002039939;2070.492729281321;2096.0253482130806;2098.475381154711;2083.427057559168;2109.3566462229014;2111.155537784898;2111.831053515715;2112.9788702112937;6971.442284617269;7063.328983746587;7064.222935477144;7067.363937245673;7069.752558660422;4100.261952848486;4195.958040419588;4201.138766552849;4201.852935147286;4203.138356636912;2539.4667119904843;2629.907953221628;2631.2369412870244;2643.590243512259;2657.4153686189006;808.9716859909934;825.8100636853497;838.5220424358118;851.7402192331336;851.9872201916976;9775.853362199572;9808.16630586401;9815.509224538744;9824.90175098254;9826.508674566243;3728.440733889938;3773.603771603997;3881.378979363288;3888.51393575803;3898.7075969302414;8403.621837017348;8403.70587029451;8405.369597280107;8406.41155119148;8417.537035463109;4212.326027835532;4231.534531201565;4233.216854881856;4234.322508398642;4242.915141697149;3831.0230891122587;3870.2259548090497;3870.8838734838;3872.496575445174;3890.1636148228267;2975.226441125323;3031.1209749172494;3079.13784140441;3128.499440089575;3426.554547908806;1095.8191898336845;1118.562646998603;1120.8318752187074;1122.4499995002552;1124.966251012471;908.4730856103445;965.2567523007245;972.5234635028785;1204.2533629149982;1205.198542968916;6674.566153200027;6678.766243181465;6733.259341472434;6774.119364482585;6779.186497620317;1018.9337693049928;1020.4897551224387;1022.6369638778127;1041.833306670929;1046.1787496814964;5121.359830021247;5316.016536940679;5319.5744340452675;5326.573874090063;5333.599980001515;8300.460470069425;8598.441101328393;8617.181367770052;8644.78388040304;8827.69103081389;8602.913970860336;8642.049374568793;8665.523396213268;8704.43421177634;8712.607932643046;6640.535162538673;6880.827979300458;6900.585964842126;6915.204751453547;6934.4452443804375;6534.444572211415;6551.836204094936;6559.770408035696;6559.967200163968;6567;7575.128860180929;7623.085229772463;7627.580483073484;7680.423968202295;7706.845863082819;7855.685772569033;7938.761837144895;8013.118556958613;8143.348532117535;8151.062627797642;6107.236595425572;6185.350538193605;6186.443220110032;6188.721507532262;6189.96905015472;6428.292887782433;6840.623765692934;6848.246692863681;6857.074294970115;6931.202911665223;6329.050642403677;6351.333110023381;6491.545591808528;6581.736730530725;6582;6225.3774622537385;6279.654618995999;6381.138546296191;6396.744130234739;6401.167848179707;6394.584352017104;6523.282438931808;6532.608043517404;6535;6541.313162117909;6077.726502307495;6107.84730381744;6108.144859719554;6113.602615829956;6134.8159555213415;5926.259217597801;5998.190244317136;6012.098185272244;6028.487578555872;6045.697715114315 05:13:06 INFO - 2015-12-10 05:13:06,544 DEBUG : BROWSER_OUTPUT: |4;prototype.html;305.57677616501144;311.37103051835294;314.18312387791747;320.38006457504713;320.6921355498721;5179.145441002235;5252.448492908247;5272.051030814457;5272.630915835893;5276.182191760274;5199.428062913076;5199.870003249921;5200.14197657387;5200.947990520093;5214.791408343662;3879.1853710720643;4001.2597669431248;4052.817623206948;4088.1823635272917;4093.9181216375655;3978.6817054635558;4053.61490658387;4064.7967601619803;4077.041895154636;4109.445224894631;4052.5542190359038;4054.108096218827;4054.6958978076614;4055.128147448298;4066.410370496291;3832.885013449587;3912.43269725891;3938.6455219030427;4002.899927501807;4058.756474611518;3598.7660802048044;3599.7300202484657;3608.981955090234;3612.2233719750116;3617.8371973261264;4963.305137280748;4984.77568509418;4994.275830004665;5005;5007.298978143063;4673.158831410345;4688.5545873142;4688.976555117202;4692.061587682477;4697.53024697531;5311.601629877775;5436.048691478975;5441.700706461143;5473.397926228152;5483.670979741229;3825.6939444844347;3826.9043273918096;3828.1003964068423;3828.636279553438;3829.2341531693774;5643.661380317153;5695.231143795576;5733.799317023884;5750.281214848144;5755.597108202385;3989.860354887565;3991.4212439196153;3996.140829721624;3999.560048394674;4000.8399664013696;3841.7694938303234;3985.0236692010644;4026.053877338823;4051.9870032491876;4053.574374690674;4603.263477843529;4605.0559635274685;4605.641335805945;4613.146567884952;4614.238650622609;5511.0080185566185;5517.531009864127;5517.779288828402;5519.448055194529;5519.613627046068;1406.296851574213;1427.0581416265215;1427.7144571085823;1428.0788891165348;1428.649980754701;959.4627008875052;968.0029569543382;968.0271327316002;982.7150126463389;990.153418826907;4842.903141937141;4843.07981483517;4853.733044682505;4859.173940430135;4860.854174374775;5654.660720356709;5663.122216056518;5665.603407761417;5669.489745922887;5671.914921276184;4809.302651115639;4846.442659094178;4847.709137451694;4850.151223535938;4856.198727210041;2916.83957382346;2944.4405562943402;3029.242689327668;3059.6481404638307;3065.540168974672;5437.238786569884;5460.781568737206;5463;5466.863328416742;5475.6440831345835;5860.384659610765;5864;5875.9118613220835;5881.294244690579;5886.3230728465915;5302.522772950453;5446.754896029609;5446.891062178814;5448.727563621882;5450.618456708072;5701.173329867063;5703.942960570507;5711.914321285101;5717.885642287048;5721.027425337619;5595.5523558116065;5604.159376093618;5605.439456054362;5614.85962850932;5616.831495055155;5439.075357189208;5453.318335208099;5459.426760190282;5467.152591348347;5472.097103977799;3895.376739721631;3974.0859602291057;3982.5420076691553;3996.720229583901;4004.339284018221;5696.971515142398;5697.943020569741;5699.4300569944335;5699.857503562278;5708.086706127;5449.427810079885;5486.835394938158;5491.697956612425;5494.752736126964;5501.229827824188;5470.945290547203;5478.233047373451;5484.232207491034;5489.670619762827;5498.80754173602;5236.031334203185;5391.649542779707;5391.892162156813;5396.784128634968;5398.4871437213405;5536.307961504812;5542.279503664659;5545.556355491632;5546.889062218814;5549.916751248654;5389.164679474688;5390.4879036491475;5394.811181608625;5420.593455490775;5427.728613569227 05:13:06 INFO - 2015-12-10 05:13:06,545 DEBUG : BROWSER_OUTPUT: |5;yui.html;608.3521050081665;646.8156575376016;736.4366259811242;738.3871386748997;795.443189767163;11959.521619135236;12208.694782630417;12229.143959922809;12285.63143105706;12292.078094142931;11824.645260642174;12259.448324825382;12278.324692141929;12287.38563071845;12293.44679489423;645.5835985789163;654.0679531667355;794.614611913223;820.995895020524;826.330672155553;820.5199958024563;826.7850358906668;831.3889291370867;831.9833603327929;832.1512057701141;861.9138086191363;872.4459967920385;872.764353624521;873.4846440600045;873.6680061576592;667.7395815631908;676.7191615479595;844.252836239929;857.9571021448903;858.2919091749269;634.4416913116474;634.5748348606398;634.6128861394545;635.0125554762343;635.6281575278422;12156.209846359958;12232.755344893141;12234.81647775284;12240.755184896341;12250.938745306306;10808.891911080867;11280.717982050432;11617.941910290394;11830.112741544419;11836.822447663291;8729.825403491957;8838.955805220998;8846.115388461103;8854.070322616097;8888.333374996837;3288.934221315584;3350;3357.2110554019787;3363.7981721096567;3364.327134573071;39134.804325978475;39148.80425597854;39156.21687566233;39160;39178.412323815166;9154.130357616015;9346.439213647203;9497.14525692691;9818.165455936325;10052.748681283027;15903.602409939613;16604.086775227235;16629.168541573115;16632.085235312174;16655.83344166543;6459.935400645933;6492.902606460907;6530.2816690164045;6533.509986751013;6782.525223234326;3536.0806190390686;3568.0544655666267;3571.1250743567994;3608.548931383577;3659.817009149585;2767.8200916940336;2773.1264651635074;2792.0367473221704;2796.245013846291;2798.2444739920516;483.04598418124624;483.784715801465;490.4629430773297;498.8328909815253;504.5156649616336;408.5914085914086;419.6747520671504;437.85769624872046;460.94238220222474;513.4172713969597;6982.720691172296;7129.607871567114;7295.744648937261;8391.622376992927;8505.872411913826;373.4566206170016;432.55662945480503;454.96360291176626;477.34365247784297;478.95109709735567;3288;3489.2323688788424;3493.1092571394133;3566.6433356664643;3576.2668652926086;49435;50177.49822501801;50545;50661.493385065674;50776.492235077916;44089.77955110204;44916.10167796626;45401;45413.318800218025;45432;41006.38490422646;41244.1751164969;41286.1742765149;41606.375904361455;41885.371719424234;6906.723731050702;6955.374016338554;6971.790846274417;7005.334493223136;7172.390346820579;29485.705142948296;30215.546766798954;30836;30870.69129308678;31346.68653313529;39871.80064099661;40291.798541007105;40395.19209615733;40505.59494405018;40879;9716.328344200167;9969.750756230862;9994.750131246486;10201.948990255001;10445.68662940113;10528.78942421132;10534.209934255116;10731.409772462277;10937.12502999774;11009.889901100887;10788.730281743019;10895.455227238448;11120.221584489009;11141;11788.528458861549;10720.088792452418;10770.13838892871;10811.6215932442;10884.61903833362;11247.718807029889;10783;10827.783444330911;10916.126709863032;11181.737949088933;11264.66206013821;8823.161799629024;8856.512891791013;9110.362274640976;9137.177654011171;9406.247500200105;8557.871631925402;8745.387822852339;8910.198082172636;8911.866322005304;8990.595423206103 05:13:06 INFO - 2015-12-10 05:13:06,545 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:13:06 INFO - 2015-12-10 05:13:06,545 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:13:06 INFO - 2015-12-10 05:13:06,545 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,903 05:13:06 INFO - 2015-12-10 05:13:06,545 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:13:06 INFO - 2015-12-10 05:13:06,546 DEBUG : BROWSER_OUTPUT: __startTimestamp1449753186531__endTimestamp 05:13:06 INFO - 2015-12-10 05:13:06,546 DEBUG : BROWSER_OUTPUT: 05:13:06 INFO - 2015-12-10 05:13:06,546 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:13:06 INFO - 2015-12-10 05:13:06,546 DEBUG : BROWSER_OUTPUT: Number of tests: 6 05:13:06 INFO - 2015-12-10 05:13:06,546 DEBUG : BROWSER_OUTPUT: 05:13:06 INFO - 2015-12-10 05:13:06,546 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4591.84 Median:4720.60 stddev:475.23 (10.1%) stddev-sans-first:450.99 05:13:06 INFO - 2015-12-10 05:13:06,548 DEBUG : BROWSER_OUTPUT: Values: 2626.8 2687.0 2692.3 2703.4 2727.0 4575.1 4677.6 4686.2 4698.0 4724.0 4574.9 4638.4 4689.8 4711.4 4727.0 4292.6 4293.9 4304.9 4309.9 4343.8 4158.9 4405.6 4416.8 4465.4 4465.8 4181.0 4240.9 4263.8 4273.8 4274.7 4221.7 4269.1 4271.7 4316.1 4316.6 4129.1 4255.4 4259.9 4284.4 4312.3 4411.0 4471.6 4491.0 4540.1 4570.7 5027.2 5053.3 5055.7 5089.3 5100.3 4814.2 5065.4 5068.1 5080.9 5083.9 4546.7 4583.2 4597.6 4604.1 4644.9 5116.7 5122.7 5158.2 5179.4 5182.2 4665.3 4918.0 4918.1 4927.4 4947.0 4862.3 4889.9 4900.2 4949.6 5018.5 4918.4 4920.9 4925.3 4935.4 4974.4 4720.6 4913.5 4916.5 4919.4 4964.6 4063.5 4076.5 4081.4 4085.2 4145.1 3611.7 3633.1 3642.8 3671.0 3672.7 4354.0 4370.8 4371.6 4374.7 4412.6 4809.4 4900.2 4901.0 4907.7 5022.6 4306.6 4313.2 4329.2 4329.3 4350.8 4368.1 4369.6 4409.0 4413.0 4451.7 4594.8 4711.3 4711.8 4778.9 4826.9 4869.6 4915.9 4934.4 4934.9 4973.4 4795.7 4798.9 4800.1 4801.0 4844.4 4793.0 4897.1 4902.1 4952.2 5001.8 4876.4 4910.0 4932.1 4942.4 4969.8 4805.3 4807.0 4807.6 4836.6 4846.2 4672.9 4768.1 4769.7 4798.5 4847.8 4702.3 4783.8 4802.0 4803.1 4854.7 4965.4 4968.4 4972.0 4996.5 5005.6 4518.1 4574.9 4606.3 4845.2 4848.4 05:13:06 INFO - 2015-12-10 05:13:06,548 DEBUG : BROWSER_OUTPUT: 05:13:06 INFO - 2015-12-10 05:13:06,548 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:36468.66 Median:34950.24 stddev:51984.39 (148.7%) stddev-sans-first:52060.32 05:13:06 INFO - 2015-12-10 05:13:06,548 DEBUG : BROWSER_OUTPUT: Values: 566.0 570.9 576.2 577.3 577.3 27268.6 27814.0 27841.2 27844.0 35797.0 40766.2 41377.8 41413.6 41414.4 41420.0 7913.3 8089.3 8090.4 8090.4 8101.7 7113.8 7252.8 7257.1 7259.8 7882.6 7044.4 7141.9 9996.9 10162.4 10166.9 9806.7 9905.4 9913.7 9916.9 9918.8 7142.2 9729.5 9857.4 9867.0 9870.7 25658.0 42041.0 42854.8 43011.1 43053.1 2648.1 2684.5 2891.0 3576.6 3659.4 25256.6 26202.7 27074.5 27240.0 27620.2 3406.7 3414.9 3418.3 3423.4 3472.6 178280.0 178550.0 180002.0 180669.0 180877.0 52376.5 52599.0 52631.0 52683.2 52742.0 55733.7 55971.7 55998.0 56173.7 56200.0 14176.1 14615.2 14625.0 14625.2 14639.6 10876.1 10957.9 10958.2 10977.9 10979.8 19055.2 19497.0 19502.2 19512.2 19519.9 7001.3 7191.2 7231.7 7262.4 7344.7 795.4 801.6 824.5 863.3 992.7 26776.6 26916.7 27307.5 27325.7 27347.6 809.6 847.7 882.5 921.7 943.5 12556.6 12876.5 12959.9 12965.5 13000.3 245792.0 250328.0 251591.0 251820.0 251897.0 38632.6 39136.6 44489.1 45054.3 45114.0 1165.7 1166.1 1171.6 1184.7 1187.5 23295.7 23516.3 24136.9 24677.4 25872.2 37681.4 37895.2 38116.2 38125.2 38239.6 158657.0 159311.0 159314.0 159362.0 160026.0 26574.9 26994.0 27042.5 27065.5 27088.7 36919.0 37994.4 40656.0 41602.2 41701.6 35055.8 35142.6 35262.5 35619.8 36037.5 34225.5 34836.5 34836.7 34844.7 35094.3 34292.3 34772.7 35107.1 35187.8 35254.5 30683.8 31399.5 32047.2 32054.0 32086.4 24088.6 24406.3 24466.5 24637.8 24648.8 05:13:06 INFO - 2015-12-10 05:13:06,548 DEBUG : BROWSER_OUTPUT: 05:13:06 INFO - 2015-12-10 05:13:06,548 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:26474.33 Median:24591.37 stddev:83084.51 (337.9%) stddev-sans-first:83294.41 05:13:06 INFO - 2015-12-10 05:13:06,549 DEBUG : BROWSER_OUTPUT: Values: 339.3 339.3 339.8 342.4 343.1 13356.5 13636.7 14966.2 15178.8 16628.2 9322.6 13175.3 16403.2 16522.9 16535.1 4511.2 4640.5 4644.3 4649.2 4650.6 3503.1 3601.8 4598.1 4623.0 4624.7 5099.8 5201.4 5233.6 5234.9 5283.9 4872.0 5143.3 5163.1 5176.0 5981.2 5296.1 5302.9 5305.1 5310.9 5325.7 11427.7 11442.9 11445.6 12299.8 19513.9 1715.1 1752.1 1813.0 1832.9 1848.7 8757.0 9044.5 9312.8 11137.3 12660.2 1719.5 1733.5 1752.5 1772.8 1779.0 53928.5 57183.4 57325.0 57445.7 57557.4 9586.3 9731.7 9761.9 9779.8 9832.0 12285.9 12345.9 12352.8 12359.0 12362.4 6758.9 6865.6 7126.1 7130.2 7238.3 6231.3 6348.2 6352.5 6352.8 6736.4 3995.9 4011.4 4023.8 4126.6 4127.6 1633.1 1638.4 1657.9 1713.8 1780.4 376.6 769.2 796.6 801.3 996.3 8601.2 9130.8 9151.8 9467.1 15310.0 757.2 782.6 797.7 800.1 827.3 8633.4 8944.7 9049.7 9223.4 9324.4 488840.0 490000.0 497356.0 522013.0 541350.0 69365.3 70384.6 71357.6 71955.6 72319.0 1060.2 1061.2 1068.8 1070.1 1091.5 14502.3 14667.3 14680.0 14845.2 15137.7 33001.5 33194.3 33709.3 33961.0 33969.5 42999.6 43959.8 44671.6 45304.5 46021.1 8010.4 8457.4 8467.0 8487.8 8606.1 10048.6 10057.1 10186.4 10188.7 10294.4 11645.4 13390.3 13678.6 13750.4 13975.3 12877.5 13103.7 13111.3 13322.8 13522.1 13521.0 13547.9 14400.9 14534.9 15106.8 9046.4 9309.8 9332.8 9398.0 9399.2 9622.1 9729.8 12237.0 12811.0 13888.0 05:13:06 INFO - 2015-12-10 05:13:06,550 DEBUG : BROWSER_OUTPUT: 05:13:06 INFO - 2015-12-10 05:13:06,550 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4982.92 Median:6187.58 stddev:2604.65 (42.1%) stddev-sans-first:2596.58 05:13:06 INFO - 2015-12-10 05:13:06,550 DEBUG : BROWSER_OUTPUT: Values: 1217.9 1650.2 1685.4 1704.4 1736.4 5849.2 6818.7 6975.4 7019.6 7032.1 6834.5 6978.1 7003.0 7006.2 7008.8 1767.5 1796.0 1953.8 1993.4 1994.7 2083.1 2091.3 2094.2 2094.5 2095.5 2009.6 2021.3 2052.7 2054.1 2056.5 2024.7 2040.0 2070.5 2096.0 2098.5 2083.4 2109.4 2111.2 2111.8 2113.0 6971.4 7063.3 7064.2 7067.4 7069.8 4100.3 4196.0 4201.1 4201.9 4203.1 2539.5 2629.9 2631.2 2643.6 2657.4 809.0 825.8 838.5 851.7 852.0 9775.9 9808.2 9815.5 9824.9 9826.5 3728.4 3773.6 3881.4 3888.5 3898.7 8403.6 8403.7 8405.4 8406.4 8417.5 4212.3 4231.5 4233.2 4234.3 4242.9 3831.0 3870.2 3870.9 3872.5 3890.2 2975.2 3031.1 3079.1 3128.5 3426.6 1095.8 1118.6 1120.8 1122.4 1125.0 908.5 965.3 972.5 1204.3 1205.2 6674.6 6678.8 6733.3 6774.1 6779.2 1018.9 1020.5 1022.6 1041.8 1046.2 5121.4 5316.0 5319.6 5326.6 5333.6 8300.5 8598.4 8617.2 8644.8 8827.7 8602.9 8642.0 8665.5 8704.4 8712.6 6640.5 6880.8 6900.6 6915.2 6934.4 6534.4 6551.8 6559.8 6560.0 6567.0 7575.1 7623.1 7627.6 7680.4 7706.8 7855.7 7938.8 8013.1 8143.3 8151.1 6107.2 6185.4 6186.4 6188.7 6190.0 6428.3 6840.6 6848.2 6857.1 6931.2 6329.1 6351.3 6491.5 6581.7 6582.0 6225.4 6279.7 6381.1 6396.7 6401.2 6394.6 6523.3 6532.6 6535.0 6541.3 6077.7 6107.8 6108.1 6113.6 6134.8 5926.3 5998.2 6012.1 6028.5 6045.7 05:13:06 INFO - 2015-12-10 05:13:06,551 DEBUG : BROWSER_OUTPUT: 05:13:06 INFO - 2015-12-10 05:13:06,551 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4568.52 Median:5225.41 stddev:1338.27 (25.6%) stddev-sans-first:1303.21 05:13:06 INFO - 2015-12-10 05:13:06,551 DEBUG : BROWSER_OUTPUT: Values: 305.6 311.4 314.2 320.4 320.7 5179.1 5252.4 5272.1 5272.6 5276.2 5199.4 5199.9 5200.1 5200.9 5214.8 3879.2 4001.3 4052.8 4088.2 4093.9 3978.7 4053.6 4064.8 4077.0 4109.4 4052.6 4054.1 4054.7 4055.1 4066.4 3832.9 3912.4 3938.6 4002.9 4058.8 3598.8 3599.7 3609.0 3612.2 3617.8 4963.3 4984.8 4994.3 5005.0 5007.3 4673.2 4688.6 4689.0 4692.1 4697.5 5311.6 5436.0 5441.7 5473.4 5483.7 3825.7 3826.9 3828.1 3828.6 3829.2 5643.7 5695.2 5733.8 5750.3 5755.6 3989.9 3991.4 3996.1 3999.6 4000.8 3841.8 3985.0 4026.1 4052.0 4053.6 4603.3 4605.1 4605.6 4613.1 4614.2 5511.0 5517.5 5517.8 5519.4 5519.6 1406.3 1427.1 1427.7 1428.1 1428.6 959.5 968.0 968.0 982.7 990.2 4842.9 4843.1 4853.7 4859.2 4860.9 5654.7 5663.1 5665.6 5669.5 5671.9 4809.3 4846.4 4847.7 4850.2 4856.2 2916.8 2944.4 3029.2 3059.6 3065.5 5437.2 5460.8 5463.0 5466.9 5475.6 5860.4 5864.0 5875.9 5881.3 5886.3 5302.5 5446.8 5446.9 5448.7 5450.6 5701.2 5703.9 5711.9 5717.9 5721.0 5595.6 5604.2 5605.4 5614.9 5616.8 5439.1 5453.3 5459.4 5467.2 5472.1 3895.4 3974.1 3982.5 3996.7 4004.3 5697.0 5697.9 5699.4 5699.9 5708.1 5449.4 5486.8 5491.7 5494.8 5501.2 5470.9 5478.2 5484.2 5489.7 5498.8 5236.0 5391.6 5391.9 5396.8 5398.5 5536.3 5542.3 5545.6 5546.9 5549.9 5389.2 5390.5 5394.8 5420.6 5427.7 05:13:06 INFO - 2015-12-10 05:13:06,551 DEBUG : BROWSER_OUTPUT: 05:13:06 INFO - 2015-12-10 05:13:06,551 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12276.44 Median:426.12 stddev:13892.74 (3260.3%) stddev-sans-first:13904.08 05:13:06 INFO - 2015-12-10 05:13:06,553 DEBUG : BROWSER_OUTPUT: Values: 608.4 646.8 736.4 738.4 795.4 11959.5 12208.7 12229.1 12285.6 12292.1 11824.6 12259.4 12278.3 12287.4 12293.4 645.6 654.1 794.6 821.0 826.3 820.5 826.8 831.4 832.0 832.2 861.9 872.4 872.8 873.5 873.7 667.7 676.7 844.3 858.0 858.3 634.4 634.6 634.6 635.0 635.6 12156.2 12232.8 12234.8 12240.8 12250.9 10808.9 11280.7 11617.9 11830.1 11836.8 8729.8 8839.0 8846.1 8854.1 8888.3 3288.9 3350.0 3357.2 3363.8 3364.3 39134.8 39148.8 39156.2 39160.0 39178.4 9154.1 9346.4 9497.1 9818.2 10052.7 15903.6 16604.1 16629.2 16632.1 16655.8 6459.9 6492.9 6530.3 6533.5 6782.5 3536.1 3568.1 3571.1 3608.5 3659.8 2767.8 2773.1 2792.0 2796.2 2798.2 483.0 483.8 490.5 498.8 504.5 408.6 419.7 437.9 460.9 513.4 6982.7 7129.6 7295.7 8391.6 8505.9 373.5 432.6 455.0 477.3 479.0 3288.0 3489.2 3493.1 3566.6 3576.3 49435.0 50177.5 50545.0 50661.5 50776.5 44089.8 44916.1 45401.0 45413.3 45432.0 41006.4 41244.2 41286.2 41606.4 41885.4 6906.7 6955.4 6971.8 7005.3 7172.4 29485.7 30215.5 30836.0 30870.7 31346.7 39871.8 40291.8 40395.2 40505.6 40879.0 9716.3 9969.8 9994.8 10201.9 10445.7 10528.8 10534.2 10731.4 10937.1 11009.9 10788.7 10895.5 11120.2 11141.0 11788.5 10720.1 10770.1 10811.6 10884.6 11247.7 10783.0 10827.8 10916.1 11181.7 11264.7 8823.2 8856.5 9110.4 9137.2 9406.2 8557.9 8745.4 8910.2 8911.9 8990.6 05:13:06 INFO - 2015-12-10 05:13:06,553 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:13:06 INFO - 2015-12-10 05:13:06,553 DEBUG : BROWSER_OUTPUT: 05:13:07 INFO - 2015-12-10 05:13:07,295 INFO : Browser exited with error code: 0 05:13:07 INFO - 2015-12-10 05:13:07,311 INFO : Completed test dromaeo_css (00:18:37) 05:13:07 INFO - 2015-12-10 05:13:07,311 INFO : Starting test kraken 05:13:07 INFO - 2015-12-10 05:13:07,311 DEBUG : operating with platform_type : linux_ 05:13:07 INFO - 2015-12-10 05:13:07,311 INFO : Initialising browser for kraken test... 05:13:07 INFO - 2015-12-10 05:13:07,317 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpik0LYO/profile http://localhost:38407/getInfo.html 05:13:11 INFO - 2015-12-10 05:13:11,447 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:13:11 INFO - 2015-12-10 05:13:11,448 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:13:11 INFO - 2015-12-10 05:13:11,448 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:13:11 INFO - 2015-12-10 05:13:11,448 DEBUG : BROWSER_OUTPUT: __metrics 05:13:11 INFO - 2015-12-10 05:13:11,605 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:13:11 INFO - 2015-12-10 05:13:11,667 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:13:12 INFO - 2015-12-10 05:13:12,837 INFO : Browser initialized. 05:13:12 INFO - 2015-12-10 05:13:12,838 INFO : Running cycle 1/1 for kraken test... 05:13:12 INFO - 2015-12-10 05:13:12,838 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpik0LYO/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:13:24 INFO - 2015-12-10 05:13:24,837 DEBUG : BROWSER_OUTPUT: RSS: Main: 143020032 05:13:24 INFO - 2015-12-10 05:13:24,837 DEBUG : BROWSER_OUTPUT: 05:13:27 INFO - 2015-12-10 05:13:27,479 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:38407/tests/kraken/driver.html?testName=audio-beat-detection) 05:13:28 INFO - 2015-12-10 05:13:28,060 DEBUG : BROWSER_OUTPUT: RSS: Main: 176873472 05:13:28 INFO - 2015-12-10 05:13:28,060 DEBUG : BROWSER_OUTPUT: 05:13:30 INFO - 2015-12-10 05:13:30,839 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:38407/tests/kraken/driver.html?testName=audio-dft) 05:13:31 INFO - 2015-12-10 05:13:31,421 DEBUG : BROWSER_OUTPUT: RSS: Main: 164950016 05:13:31 INFO - 2015-12-10 05:13:31,421 DEBUG : BROWSER_OUTPUT: 05:13:34 INFO - 2015-12-10 05:13:34,434 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:38407/tests/kraken/driver.html?testName=audio-fft) 05:13:34 INFO - 2015-12-10 05:13:34,995 DEBUG : BROWSER_OUTPUT: RSS: Main: 154107904 05:13:34 INFO - 2015-12-10 05:13:34,995 DEBUG : BROWSER_OUTPUT: 05:13:37 INFO - 2015-12-10 05:13:37,047 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:38407/tests/kraken/driver.html?testName=audio-oscillator) 05:13:37 INFO - 2015-12-10 05:13:37,616 DEBUG : BROWSER_OUTPUT: RSS: Main: 156078080 05:13:37 INFO - 2015-12-10 05:13:37,617 DEBUG : BROWSER_OUTPUT: 05:13:39 INFO - 2015-12-10 05:13:39,876 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:38407/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:13:40 INFO - 2015-12-10 05:13:40,442 DEBUG : BROWSER_OUTPUT: RSS: Main: 156516352 05:13:40 INFO - 2015-12-10 05:13:40,442 DEBUG : BROWSER_OUTPUT: 05:13:43 INFO - 2015-12-10 05:13:43,446 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:38407/tests/kraken/driver.html?testName=imaging-darkroom) 05:13:44 INFO - 2015-12-10 05:13:44,028 DEBUG : BROWSER_OUTPUT: RSS: Main: 158347264 05:13:44 INFO - 2015-12-10 05:13:44,028 DEBUG : BROWSER_OUTPUT: 05:13:47 INFO - 2015-12-10 05:13:47,409 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:38407/tests/kraken/driver.html?testName=imaging-desaturate) 05:13:47 INFO - 2015-12-10 05:13:47,979 DEBUG : BROWSER_OUTPUT: RSS: Main: 157167616 05:13:47 INFO - 2015-12-10 05:13:47,979 DEBUG : BROWSER_OUTPUT: 05:13:50 INFO - 2015-12-10 05:13:50,788 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:38407/tests/kraken/driver.html?testName=json-parse-financial) 05:13:51 INFO - 2015-12-10 05:13:51,369 DEBUG : BROWSER_OUTPUT: RSS: Main: 157147136 05:13:51 INFO - 2015-12-10 05:13:51,369 DEBUG : BROWSER_OUTPUT: 05:13:53 INFO - 2015-12-10 05:13:53,150 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:38407/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:13:53 INFO - 2015-12-10 05:13:53,716 DEBUG : BROWSER_OUTPUT: RSS: Main: 168636416 05:13:53 INFO - 2015-12-10 05:13:53,716 DEBUG : BROWSER_OUTPUT: 05:13:55 INFO - 2015-12-10 05:13:55,591 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:38407/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:13:56 INFO - 2015-12-10 05:13:56,178 DEBUG : BROWSER_OUTPUT: RSS: Main: 168321024 05:13:56 INFO - 2015-12-10 05:13:56,179 DEBUG : BROWSER_OUTPUT: 05:13:58 INFO - 2015-12-10 05:13:58,339 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:38407/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:13:58 INFO - 2015-12-10 05:13:58,922 DEBUG : BROWSER_OUTPUT: RSS: Main: 177909760 05:13:58 INFO - 2015-12-10 05:13:58,922 DEBUG : BROWSER_OUTPUT: 05:14:01 INFO - 2015-12-10 05:14:01,464 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:38407/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:14:02 INFO - 2015-12-10 05:14:02,053 DEBUG : BROWSER_OUTPUT: RSS: Main: 185151488 05:14:02 INFO - 2015-12-10 05:14:02,053 DEBUG : BROWSER_OUTPUT: 05:14:04 INFO - 2015-12-10 05:14:04,669 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:38407/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:14:05 INFO - 2015-12-10 05:14:05,242 DEBUG : BROWSER_OUTPUT: RSS: Main: 182792192 05:14:05 INFO - 2015-12-10 05:14:05,242 DEBUG : BROWSER_OUTPUT: 05:14:06 INFO - 2015-12-10 05:14:06,977 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:38407/tests/kraken/driver.html?testName=ai-astar) 05:14:07 INFO - 2015-12-10 05:14:07,235 DEBUG : BROWSER_OUTPUT: RSS: Main: 242315264 05:14:07 INFO - 2015-12-10 05:14:07,235 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,235 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:14:07 INFO - 2015-12-10 05:14:07,235 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:14:07 INFO - 2015-12-10 05:14:07,235 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:14:07 INFO - 2015-12-10 05:14:07,235 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |0;ai-astar;111;114;107;112;111;114;104;113;113;103 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;153;132;157;173;140;164;153;132;179;134 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;161;162;161;164;161;162;162;163;163 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |3;audio-fft;73;72;81;91;73;73;71;97;91;74 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;95;95;133;94;96;95;137;95;95;129 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;110;109;110;109;110;109;110;111;110 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;147;147;148;146;148;147;147;147;148;147 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;95;96;95;95;95;95;96;95;95 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;74;74;73;72;75;73;73;82;69;70 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;67;68;68;67;68;67;68;68;67;69 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;83;83;82;92;83;84;84;95;85;84 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;134;122;120;117;124;128;124;121;126;121 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;135;146;143;144;145;144;147;145;152;140 05:14:07 INFO - 2015-12-10 05:14:07,236 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;70;70;69;71;70;70;70;68;70;68 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,968 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: __startTimestamp1449753247230__endTimestamp 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: Number of tests: 14 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:110.20 Median:112.50 stddev:4.08 (3.6%) stddev-sans-first:4.31 05:14:07 INFO - 2015-12-10 05:14:07,237 DEBUG : BROWSER_OUTPUT: Values: 111.0 114.0 107.0 112.0 111.0 114.0 104.0 113.0 113.0 103.0 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:151.70 Median:155.00 stddev:17.02 (11.0%) stddev-sans-first:18.05 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: Values: 153.0 132.0 157.0 173.0 140.0 164.0 153.0 132.0 179.0 134.0 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:162.00 Median:162.00 stddev:1.05 (0.7%) stddev-sans-first:1.05 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: Values: 161.0 161.0 162.0 161.0 164.0 161.0 162.0 162.0 163.0 163.0 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:79.60 Median:77.50 stddev:9.77 (12.6%) stddev-sans-first:10.06 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: Values: 73.0 72.0 81.0 91.0 73.0 73.0 71.0 97.0 91.0 74.0 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:106.40 Median:95.00 stddev:18.46 (19.4%) stddev-sans-first:19.11 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 133.0 94.0 96.0 95.0 137.0 95.0 95.0 129.0 05:14:07 INFO - 2015-12-10 05:14:07,238 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.80 Median:110.00 stddev:0.63 (0.6%) stddev-sans-first:0.67 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: Values: 110.0 110.0 109.0 110.0 109.0 110.0 109.0 110.0 111.0 110.0 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:147.20 Median:147.00 stddev:0.63 (0.4%) stddev-sans-first:0.67 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: Values: 147.0 147.0 148.0 146.0 148.0 147.0 147.0 147.0 148.0 147.0 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.20 Median:95.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 96.0 95.0 95.0 95.0 95.0 96.0 95.0 95.0 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:73.50 Median:73.50 stddev:3.50 (4.8%) stddev-sans-first:3.71 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: Values: 74.0 74.0 73.0 72.0 75.0 73.0 73.0 82.0 69.0 70.0 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.70 Median:68.00 stddev:0.67 (1.0%) stddev-sans-first:0.67 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: Values: 67.0 68.0 68.0 67.0 68.0 67.0 68.0 68.0 67.0 69.0 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,239 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.50 Median:84.00 stddev:4.35 (5.2%) stddev-sans-first:4.52 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: Values: 83.0 83.0 82.0 92.0 83.0 84.0 84.0 95.0 85.0 84.0 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:123.70 Median:124.00 stddev:4.79 (3.9%) stddev-sans-first:3.32 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: Values: 134.0 122.0 120.0 117.0 124.0 128.0 124.0 121.0 126.0 121.0 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:144.10 Median:145.00 stddev:4.43 (3.1%) stddev-sans-first:3.26 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: Values: 135.0 146.0 143.0 144.0 145.0 144.0 147.0 145.0 152.0 140.0 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.60 Median:70.00 stddev:0.97 (1.4%) stddev-sans-first:1.01 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: Values: 70.0 70.0 69.0 71.0 70.0 70.0 70.0 68.0 70.0 68.0 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:14:07 INFO - 2015-12-10 05:14:07,240 DEBUG : BROWSER_OUTPUT: 05:14:08 INFO - 2015-12-10 05:14:08,147 INFO : Browser exited with error code: 0 05:14:08 INFO - 2015-12-10 05:14:08,196 INFO : Completed test kraken (00:01:00) 05:14:08 INFO - 2015-12-10 05:14:08,196 INFO : Starting test v8_7 05:14:08 INFO - 2015-12-10 05:14:08,196 DEBUG : operating with platform_type : linux_ 05:14:08 INFO - 2015-12-10 05:14:08,196 INFO : Initialising browser for v8_7 test... 05:14:08 INFO - 2015-12-10 05:14:08,202 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpIOVrJG/profile http://localhost:38407/getInfo.html 05:14:12 INFO - 2015-12-10 05:14:12,642 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:14:12 INFO - 2015-12-10 05:14:12,643 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:14:12 INFO - 2015-12-10 05:14:12,643 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:14:12 INFO - 2015-12-10 05:14:12,643 DEBUG : BROWSER_OUTPUT: __metrics 05:14:12 INFO - 2015-12-10 05:14:12,751 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 05:14:12 INFO - 2015-12-10 05:14:12,836 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:14:13 INFO - 2015-12-10 05:14:13,179 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 05:14:13 INFO - 2015-12-10 05:14:13,923 INFO : Browser initialized. 05:14:13 INFO - 2015-12-10 05:14:13,923 INFO : Running cycle 1/1 for v8_7 test... 05:14:13 INFO - 2015-12-10 05:14:13,924 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpIOVrJG/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:14:26 INFO - 2015-12-10 05:14:26,025 DEBUG : BROWSER_OUTPUT: RSS: Main: 139718656 05:14:26 INFO - 2015-12-10 05:14:26,027 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,451 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:38407/tests/v8_7/run.html (next: http://localhost:38407/tests/v8_7/run.html) 05:14:47 INFO - 2015-12-10 05:14:47,701 DEBUG : BROWSER_OUTPUT: RSS: Main: 440303616 05:14:47 INFO - 2015-12-10 05:14:47,701 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,701 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:14:47 INFO - 2015-12-10 05:14:47,702 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:14:47 INFO - 2015-12-10 05:14:47,702 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:14:47 INFO - 2015-12-10 05:14:47,703 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:14:47 INFO - 2015-12-10 05:14:47,703 DEBUG : BROWSER_OUTPUT: |0;Richards;166.22340425531914 05:14:47 INFO - 2015-12-10 05:14:47,703 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;186.74136321195144 05:14:47 INFO - 2015-12-10 05:14:47,704 DEBUG : BROWSER_OUTPUT: |2;Encrypt;278.2415136338342 05:14:47 INFO - 2015-12-10 05:14:47,704 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5122.448979591837 05:14:47 INFO - 2015-12-10 05:14:47,704 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1976.2845849802372 05:14:47 INFO - 2015-12-10 05:14:47,704 DEBUG : BROWSER_OUTPUT: |5;Earley;791.1392405063291 05:14:47 INFO - 2015-12-10 05:14:47,705 DEBUG : BROWSER_OUTPUT: |6;Boyer;12219.512195121952 05:14:47 INFO - 2015-12-10 05:14:47,705 DEBUG : BROWSER_OUTPUT: |7;RegExp;27648.64864864865 05:14:47 INFO - 2015-12-10 05:14:47,705 DEBUG : BROWSER_OUTPUT: |8;Splay;615.2905198776758 05:14:47 INFO - 2015-12-10 05:14:47,705 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4830.917874396136 05:14:47 INFO - 2015-12-10 05:14:47,706 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:14:47 INFO - 2015-12-10 05:14:47,706 DEBUG : BROWSER_OUTPUT: __startTimestamp1449753287701__endTimestamp 05:14:47 INFO - 2015-12-10 05:14:47,706 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,706 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:14:47 INFO - 2015-12-10 05:14:47,706 DEBUG : BROWSER_OUTPUT: Number of tests: 10 05:14:47 INFO - 2015-12-10 05:14:47,707 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,707 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:166.22 Median:166.22 stddev:0.00 (0.0%) 05:14:47 INFO - 2015-12-10 05:14:47,707 DEBUG : BROWSER_OUTPUT: Values: 166.2 05:14:47 INFO - 2015-12-10 05:14:47,707 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,707 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:186.74 Median:186.74 stddev:0.00 (0.0%) 05:14:47 INFO - 2015-12-10 05:14:47,707 DEBUG : BROWSER_OUTPUT: Values: 186.7 05:14:47 INFO - 2015-12-10 05:14:47,707 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,708 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:278.24 Median:278.24 stddev:0.00 (0.0%) 05:14:47 INFO - 2015-12-10 05:14:47,708 DEBUG : BROWSER_OUTPUT: Values: 278.2 05:14:47 INFO - 2015-12-10 05:14:47,708 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,708 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5122.45 Median:5122.45 stddev:0.00 (0.0%) 05:14:47 INFO - 2015-12-10 05:14:47,708 DEBUG : BROWSER_OUTPUT: Values: 5122.4 05:14:47 INFO - 2015-12-10 05:14:47,708 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,709 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1976.28 Median:1976.28 stddev:0.00 (0.0%) 05:14:47 INFO - 2015-12-10 05:14:47,710 DEBUG : BROWSER_OUTPUT: Values: 1976.3 05:14:47 INFO - 2015-12-10 05:14:47,710 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,710 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:791.14 Median:791.14 stddev:0.00 (0.0%) 05:14:47 INFO - 2015-12-10 05:14:47,710 DEBUG : BROWSER_OUTPUT: Values: 791.1 05:14:47 INFO - 2015-12-10 05:14:47,710 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,710 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12219.51 Median:12219.51 stddev:0.00 (0.0%) 05:14:47 INFO - 2015-12-10 05:14:47,710 DEBUG : BROWSER_OUTPUT: Values: 12219.5 05:14:47 INFO - 2015-12-10 05:14:47,710 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,710 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:27648.65 Median:27648.65 stddev:0.00 (0.0%) 05:14:47 INFO - 2015-12-10 05:14:47,710 DEBUG : BROWSER_OUTPUT: Values: 27648.6 05:14:47 INFO - 2015-12-10 05:14:47,711 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,711 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:615.29 Median:615.29 stddev:0.00 (0.0%) 05:14:47 INFO - 2015-12-10 05:14:47,711 DEBUG : BROWSER_OUTPUT: Values: 615.3 05:14:47 INFO - 2015-12-10 05:14:47,711 DEBUG : BROWSER_OUTPUT: 05:14:47 INFO - 2015-12-10 05:14:47,711 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4830.92 Median:4830.92 stddev:0.00 (0.0%) 05:14:47 INFO - 2015-12-10 05:14:47,711 DEBUG : BROWSER_OUTPUT: Values: 4830.9 05:14:47 INFO - 2015-12-10 05:14:47,711 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:14:47 INFO - 2015-12-10 05:14:47,711 DEBUG : BROWSER_OUTPUT: 05:14:48 INFO - 2015-12-10 05:14:48,607 INFO : Browser exited with error code: 0 05:14:48 INFO - 2015-12-10 05:14:48,622 INFO : Completed test v8_7 (00:00:40) 05:14:48 INFO - 2015-12-10 05:14:48,727 INFO : Completed test suite (00:20:18) 05:14:48 INFO - 2015-12-10 05:14:48,728 DEBUG : Working with test: dromaeo_css 05:14:48 INFO - 2015-12-10 05:14:48,728 DEBUG : Generating results file: dromaeo_css 05:14:48 INFO - 2015-12-10 05:14:48,729 DEBUG : Working with test: kraken 05:14:48 INFO - 2015-12-10 05:14:48,729 DEBUG : Generating results file: kraken 05:14:48 INFO - 2015-12-10 05:14:48,729 INFO : javascript benchmark 05:14:48 INFO - 2015-12-10 05:14:48,730 DEBUG : Working with test: v8_7 05:14:48 INFO - 2015-12-10 05:14:48,730 DEBUG : Generating results file: v8_7 05:14:48 INFO - 2015-12-10 05:14:48,730 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:14:48 INFO - 2015-12-10 05:14:48,790 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,203,35]] 05:14:48 INFO - 2015-12-10 05:14:48,790 DEBUG : process_Request line: dromaeo_css 6203.38 graph.html#tests=[[72,203,35]] 05:14:48 INFO - 2015-12-10 05:14:48,790 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:14:48 INFO - 2015-12-10 05:14:48,818 DEBUG : process_Request line: kraken 1526.20 graph.html#tests=[[232,203,35]] 05:14:48 INFO - 2015-12-10 05:14:48,818 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:14:48 INFO - 2015-12-10 05:14:48,853 DEBUG : process_Request line: v8_7 19736.99 graph.html#tests=[[230,203,35]] 05:14:48 INFO - 2015-12-10 05:14:48,855 INFO : javascript benchmark 05:14:48 INFO - 2015-12-10 05:14:48,858 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2626.7635912767846, 2687.0, 2692.259628602133, 2703.405250844815, 2726.986365068175, 4575.062112266985, 4677.649176311777, 4686.156491831469, 4698.036902435001, 4724.031573527427, 4574.885627859305, 4638.373819534362, 4689.788959496822, 4711.387519622444, 4726.952730472694, 4292.570742925714, 4293.8711838644895, 4304.9139017219795, 4309.913801723964, 4343.826246950118, 4158.896027599304, 4405.625521830648, 4416.823327066913, 4465.419495465601, 4465.82136714531, 4180.979095104505, 4240.872773816791, 4263.786810659454, 4273.807678654468, 4274.700770946035, 4221.725587836811, 4269.146170765828, 4271.658267338606, 4316.136772645452, 4316.56834316569, 4129.070959034223, 4255.4255175551525, 4259.872203833859, 4284.378765079046, 4312.331588603772, 4411.029573493858, 4471.552844715535, 4490.955090449086, 4540.114677637862, 4570.748608826513, 5027.195648696227, 5053.317802096707, 5055.721935293557, 5089.262057001714, 5100.311457953166, 4814.205656066745, 5065.366829146356, 5068.087744206042, 5080.923786143211, 5083.8983220335385, 4546.65900057497, 4583.175028494869, 4597.563231493003, 4604.102200070987, 4644.86065418038, 5116.667416617908, 5122.718250496258, 5158.200478925773, 5179.352580927384, 5182.170852663556, 4665.323528088408, 4917.975410122926, 4918.11473934688, 4927.359443272351, 4946.975265123651, 4862.294967229732, 4889.877753056202, 4900.215965445512, 4949.554540091409, 5018.5232402921665, 4918.385201849769, 4920.876978075506, 4925.261210818334, 4935.383077115361, 4974.403071631427, 4720.598749106296, 4913.48408417111, 4916.459189489225, 4919.3604831371695, 4964.627652926045, 4063.5326937401987, 4076.4700588923843, 4081.3673880548563, 4085.162541678949, 4145.108801607669, 3611.656892595199, 3633.073566240592, 3642.7996460194413, 3670.981645091811, 3672.706183505313, 4354.0, 4370.847020354272, 4371.606555409965, 4374.650027997753, 4412.646988240933, 4809.44691360498, 4900.215965445512, 4901.019796040806, 4907.656464047483, 5022.573081288131, 4306.612404883575, 4313.245182093184, 4329.242382583036, 4329.264025115738, 4350.847720329773, 4368.060866913629, 4369.584889435499, 4408.977955110204, 4413.007073408522, 4451.666125040635, 4594.793234304398, 4711.340412342206, 4711.764411779329, 4778.880527986758, 4826.855194344175, 4869.634777391639, 4915.877103072452, 4934.358533390637, 4934.8766280843265, 4973.378327709036, 4795.688280261772, 4798.856034318976, 4800.087983283165, 4801.039792041536, 4844.394450693663, 4792.95207047925, 4897.118518666532, 4902.093112774148, 4952.1581331173065, 5001.824936127218, 4876.390451193601, 4909.950900491092, 4932.136876046606, 4942.382202224722, 4969.751512424436, 4805.255185446262, 4806.990531988322, 4807.591354734886, 4836.637252206028, 4846.151923413459, 4672.906541869212, 4768.094062128184, 4769.66612337133, 4798.5441383068555, 4847.781849816696, 4702.294655801657, 4783.808647654055, 4802.039592081667, 4803.087413391444, 4854.660173787801, 4965.4289756677, 4968.403791545038, 4971.950280497149, 4996.475370086088, 5005.599552035901, 4518.051209246095, 4574.88562785933, 4606.286025666027, 4845.248986407112, 4848.369711937426], "unit": "ms", "name": "dojo.html", "value": 4562.686457056457}, {"lowerIsBetter": false, "replicates": [565.9547236221102, 570.8572856785801, 576.2249774053898, 577.2668710737366, 577.2956992469188, 27268.590971135425, 27814.0, 27841.164765057056, 27844.0, 35797.0, 40766.18467630645, 41377.7931110344, 41413.58586414135, 41414.37878431826, 41420.0, 7913.327367173797, 8089.271965523102, 8090.433669643127, 8090.433669643127, 8101.716439924604, 7113.786586402416, 7252.818679533001, 7257.056582644249, 7259.782206533812, 7882.60586970652, 7044.366007059363, 7141.89287160693, 9996.90003099967, 10162.39025658463, 10166.881643019262, 9806.705798826011, 9905.405675659411, 9913.702588922344, 9916.900830991706, 9918.752031199278, 7142.21435642079, 9729.464879431629, 9857.35927164732, 9866.950665246699, 9870.703878883573, 25658.0, 42041.0, 42854.78572607148, 43011.1397772046, 43053.138937221396, 2648.0864101884818, 2684.476527077221, 2890.956635650446, 3576.6423357664025, 3659.396199627058, 25256.621150682753, 26202.73797262022, 27074.458510829674, 27240.0, 27620.171394858186, 3406.744494162948, 3414.931701365959, 3418.316336732639, 3423.4351332030433, 3472.5659292588425, 178280.0, 178550.0, 180002.0, 180669.0, 180877.0, 52376.47623523716, 52599.0, 52630.999999999236, 52683.209751853756, 52742.0, 55733.721331393084, 55971.72014139903, 55998.0, 56173.71913140408, 56200.0, 14176.149431033964, 14615.196164210858, 14625.0, 14625.195614241318, 14639.634009149857, 10876.12990960737, 10957.890421095686, 10958.178136639784, 10977.890221097687, 10979.780404392028, 19055.230597861097, 19497.0, 19502.219911203392, 19512.21951121939, 19519.90240048819, 7001.264867188974, 7191.208967013625, 7231.74688885897, 7262.419006479469, 7344.742933997284, 795.4074214709963, 801.6232370785722, 824.517657170562, 863.3266052479077, 992.6773798515511, 26776.59835102475, 26916.73083269142, 27307.453850923266, 27325.726742732317, 27347.589786153225, 809.6316176139842, 847.720252316734, 882.4572887674034, 921.7326975177124, 943.5423819447562, 12556.560520381925, 12876.484940602271, 12959.870401295866, 12965.481380744664, 13000.284984325765, 245792.0, 250328.0, 251591.0, 251820.0, 251897.0, 38632.61367386347, 39136.608633913864, 44489.11021779611, 45054.32418513725, 45114.0, 1165.6910918606577, 1166.1429497730594, 1171.6075114836456, 1184.650528094197, 1187.5249900040053, 23295.650565241875, 23516.29451116469, 24136.87931560331, 24677.38306542351, 25872.223833285032, 37681.43477847779, 37895.24209515849, 38116.237675245786, 38125.237495249385, 38239.61760382361, 158657.0, 159311.0, 159314.0, 159362.0, 160026.0, 26574.86712566425, 26994.0, 27042.459150817267, 27065.45869082647, 27088.72911270941, 36919.0, 37994.43008354932, 40656.0, 41602.1679566413, 41701.582984170986, 35055.82472087623, 35142.64857351496, 35262.47106293459, 35619.82190089033, 36037.45943810792, 34225.486617700255, 34836.477452837724, 34836.65163348334, 34844.65155348414, 35094.29811403809, 34292.314153717285, 34772.65227347795, 35107.12232194216, 35187.82406087953, 35254.47118293176, 30683.846580766953, 31399.529007064455, 32047.198820029687, 32054.0, 32086.35827283488, 24088.638670420307, 24406.26781196567, 24466.51066978686, 24637.753622463544, 24648.753512464646], "unit": "ms", "name": "ext.html", "value": 16557.820739206334}, {"lowerIsBetter": false, "replicates": [339.3044259268499, 339.31119826751694, 339.75707369231003, 342.38712704259376, 343.0976531721572, 13356.532521361754, 13636.72726545471, 14966.17686027268, 15178.785697144229, 16628.168591570404, 9322.580483878224, 13175.275359855204, 16403.17984100796, 16522.917385413086, 16535.090570018645, 4511.187986162489, 4640.489546149921, 4644.303354496836, 4649.232876575378, 4650.604698600606, 3503.10670778951, 3601.783892966417, 4598.057398233354, 4623.0, 4624.653151013671, 5099.847004589849, 5201.375834899817, 5233.633645644806, 5234.8691282717855, 5283.947160528403, 4872.0, 5143.305653736754, 5163.096458119833, 5176.0, 5981.192539007222, 5296.126139187029, 5302.867428314285, 5305.098133317345, 5310.946890531084, 5325.733713314319, 11427.657170284821, 11442.942785286103, 11445.599404020819, 12299.754004919852, 19513.9024304879, 1715.1424287856073, 1752.088913764835, 1812.9637407251912, 1832.8533717302716, 1848.7134494153427, 8757.0, 9044.502552359618, 9312.83589551306, 11137.276077054965, 12660.240385576895, 1719.5443207550009, 1733.514615907548, 1752.5443384719938, 1772.822717728217, 1778.9555261118446, 53928.460715392735, 57183.42816571823, 57325.0, 57445.712771436294, 57557.42442575563, 9586.281028922858, 9731.65939192139, 9761.902380976242, 9779.755506112404, 9831.950840245752, 12285.877141228473, 12345.876541234473, 12352.75294494123, 12359.0, 12362.38188090592, 6758.8648227036165, 6865.588064716133, 7126.109236345457, 7130.215676275606, 7238.312360325761, 6231.345708700612, 6348.238211414659, 6352.491800656029, 6352.777652782131, 6736.360045795642, 3995.92110130269, 4011.4183443400543, 4023.8189281482405, 4126.628603425706, 4127.628513433805, 1633.1017940132879, 1638.4101723379574, 1657.9005259684457, 1713.811480737118, 1780.3590707345345, 376.6083273395638, 769.1539306762628, 796.6454927557181, 801.2708435323827, 996.292632231124, 8601.182887625666, 9130.81738365229, 9151.816963660689, 9467.147956683932, 15310.0, 757.1784613694203, 782.5695867272977, 797.6649807080923, 800.083903929997, 827.3381294964005, 8633.39566230358, 8944.68693595721, 9049.683261085962, 9223.44659320443, 9324.440533568008, 488840.0, 490000.0, 497356.0, 522013.0, 541350.0, 69365.3063469369, 70384.64807675929, 71357.64321178464, 71955.64022179961, 72319.0, 1060.151878497199, 1061.1722856172198, 1068.7969285835666, 1070.1118072000222, 1091.49245600796, 14502.347394367489, 14667.266636667911, 14680.0, 14845.183514906785, 15137.697246055237, 33001.50497742488, 33194.33611327712, 33709.325813483105, 33961.0, 33969.49045764266, 42999.57000429956, 43959.78020109879, 44671.55328446804, 45304.54695453135, 46021.07957840891, 8010.399220058635, 8457.40798144124, 8467.026291976255, 8487.830243395221, 8606.139386061344, 10048.648297309559, 10057.145142662956, 10186.388816671024, 10188.745281367728, 10294.3823370595, 11645.41772911368, 13390.330483475593, 13678.589642310746, 13750.449982000608, 13975.301234938415, 12877.549285774952, 13103.737925241632, 13111.27887966171, 13322.800157997832, 13522.053456258362, 13521.0, 13547.86452135466, 14400.927995359956, 14534.92732536373, 15106.773398399253, 9046.366754327133, 9309.789727335674, 9332.81334373295, 9397.953010234905, 9399.201067909304, 9622.085901839315, 9729.805403892024, 12237.0, 12811.0, 13887.958403120008], "unit": "ms", "name": "jquery.html", "value": 7891.307854753865}, {"lowerIsBetter": false, "replicates": [1217.920835145716, 1650.1749125437282, 1685.401682402747, 1704.411977867636, 1736.4009416751223, 5849.210356601858, 6818.727250909964, 6975.4070903973225, 7019.6139212343305, 7032.12098487689, 6834.487413443999, 6978.127734033246, 7003.0, 7006.229314775371, 7008.789736307906, 1767.5492749348898, 1796.0480945099118, 1953.8241558259717, 1993.3920154352916, 1994.7207390965277, 2083.0938541734395, 2091.3098677436487, 2094.214669498938, 2094.539201375695, 2095.549456866773, 2009.6081264153495, 2021.2622392826586, 2052.6818343156833, 2054.0551346380685, 2056.5372791121954, 2024.6760518316999, 2039.9796002039939, 2070.492729281321, 2096.0253482130806, 2098.475381154711, 2083.427057559168, 2109.3566462229014, 2111.155537784898, 2111.831053515715, 2112.9788702112937, 6971.442284617269, 7063.328983746587, 7064.222935477144, 7067.363937245673, 7069.752558660422, 4100.261952848486, 4195.958040419588, 4201.138766552849, 4201.852935147286, 4203.138356636912, 2539.4667119904843, 2629.907953221628, 2631.2369412870244, 2643.590243512259, 2657.4153686189006, 808.9716859909934, 825.8100636853497, 838.5220424358118, 851.7402192331336, 851.9872201916976, 9775.853362199572, 9808.16630586401, 9815.509224538744, 9824.90175098254, 9826.508674566243, 3728.440733889938, 3773.603771603997, 3881.378979363288, 3888.51393575803, 3898.7075969302414, 8403.621837017348, 8403.70587029451, 8405.369597280107, 8406.41155119148, 8417.537035463109, 4212.326027835532, 4231.534531201565, 4233.216854881856, 4234.322508398642, 4242.915141697149, 3831.0230891122587, 3870.2259548090497, 3870.8838734838, 3872.496575445174, 3890.1636148228267, 2975.226441125323, 3031.1209749172494, 3079.13784140441, 3128.499440089575, 3426.554547908806, 1095.8191898336845, 1118.562646998603, 1120.8318752187074, 1122.4499995002552, 1124.966251012471, 908.4730856103445, 965.2567523007245, 972.5234635028785, 1204.2533629149982, 1205.198542968916, 6674.566153200027, 6678.766243181465, 6733.259341472434, 6774.119364482585, 6779.186497620317, 1018.9337693049928, 1020.4897551224387, 1022.6369638778127, 1041.833306670929, 1046.1787496814964, 5121.359830021247, 5316.016536940679, 5319.5744340452675, 5326.573874090063, 5333.599980001515, 8300.460470069425, 8598.441101328393, 8617.181367770052, 8644.78388040304, 8827.69103081389, 8602.913970860336, 8642.049374568793, 8665.523396213268, 8704.43421177634, 8712.607932643046, 6640.535162538673, 6880.827979300458, 6900.585964842126, 6915.204751453547, 6934.4452443804375, 6534.444572211415, 6551.836204094936, 6559.770408035696, 6559.967200163968, 6567.0, 7575.128860180929, 7623.085229772463, 7627.580483073484, 7680.423968202295, 7706.845863082819, 7855.685772569033, 7938.761837144895, 8013.118556958613, 8143.348532117535, 8151.062627797642, 6107.236595425572, 6185.350538193605, 6186.443220110032, 6188.721507532262, 6189.96905015472, 6428.292887782433, 6840.623765692934, 6848.246692863681, 6857.074294970115, 6931.202911665223, 6329.050642403677, 6351.333110023381, 6491.545591808528, 6581.736730530725, 6582.0, 6225.3774622537385, 6279.654618995999, 6381.138546296191, 6396.744130234739, 6401.167848179707, 6394.584352017104, 6523.282438931808, 6532.608043517404, 6535.0, 6541.313162117909, 6077.726502307495, 6107.84730381744, 6108.144859719554, 6113.602615829956, 6134.8159555213415, 5926.259217597801, 5998.190244317136, 6012.098185272244, 6028.487578555872, 6045.697715114315], "unit": "ms", "name": "mootools.html", "value": 4084.1648648976893}, {"lowerIsBetter": false, "replicates": [305.57677616501144, 311.37103051835294, 314.18312387791747, 320.38006457504713, 320.6921355498721, 5179.145441002235, 5252.448492908247, 5272.051030814457, 5272.630915835893, 5276.182191760274, 5199.428062913076, 5199.870003249921, 5200.14197657387, 5200.947990520093, 5214.791408343662, 3879.1853710720643, 4001.2597669431248, 4052.817623206948, 4088.1823635272917, 4093.9181216375655, 3978.6817054635558, 4053.61490658387, 4064.7967601619803, 4077.041895154636, 4109.445224894631, 4052.5542190359038, 4054.108096218827, 4054.6958978076614, 4055.128147448298, 4066.410370496291, 3832.885013449587, 3912.43269725891, 3938.6455219030427, 4002.899927501807, 4058.756474611518, 3598.7660802048044, 3599.7300202484657, 3608.981955090234, 3612.2233719750116, 3617.8371973261264, 4963.305137280748, 4984.77568509418, 4994.275830004665, 5005.0, 5007.298978143063, 4673.158831410345, 4688.5545873142, 4688.976555117202, 4692.061587682477, 4697.53024697531, 5311.601629877775, 5436.048691478975, 5441.700706461143, 5473.397926228152, 5483.670979741229, 3825.6939444844347, 3826.9043273918096, 3828.1003964068423, 3828.636279553438, 3829.2341531693774, 5643.661380317153, 5695.231143795576, 5733.799317023884, 5750.281214848144, 5755.597108202385, 3989.860354887565, 3991.4212439196153, 3996.140829721624, 3999.560048394674, 4000.8399664013696, 3841.7694938303234, 3985.0236692010644, 4026.053877338823, 4051.9870032491876, 4053.574374690674, 4603.263477843529, 4605.0559635274685, 4605.641335805945, 4613.146567884952, 4614.238650622609, 5511.0080185566185, 5517.531009864127, 5517.779288828402, 5519.448055194529, 5519.613627046068, 1406.296851574213, 1427.0581416265215, 1427.7144571085823, 1428.0788891165348, 1428.649980754701, 959.4627008875052, 968.0029569543382, 968.0271327316002, 982.7150126463389, 990.153418826907, 4842.903141937141, 4843.07981483517, 4853.733044682505, 4859.173940430135, 4860.854174374775, 5654.660720356709, 5663.122216056518, 5665.603407761417, 5669.489745922887, 5671.914921276184, 4809.302651115639, 4846.442659094178, 4847.709137451694, 4850.151223535938, 4856.198727210041, 2916.83957382346, 2944.4405562943402, 3029.242689327668, 3059.6481404638307, 3065.540168974672, 5437.238786569884, 5460.781568737206, 5463.0, 5466.863328416742, 5475.6440831345835, 5860.384659610765, 5864.0, 5875.9118613220835, 5881.294244690579, 5886.3230728465915, 5302.522772950453, 5446.754896029609, 5446.891062178814, 5448.727563621882, 5450.618456708072, 5701.173329867063, 5703.942960570507, 5711.914321285101, 5717.885642287048, 5721.027425337619, 5595.5523558116065, 5604.159376093618, 5605.439456054362, 5614.85962850932, 5616.831495055155, 5439.075357189208, 5453.318335208099, 5459.426760190282, 5467.152591348347, 5472.097103977799, 3895.376739721631, 3974.0859602291057, 3982.5420076691553, 3996.720229583901, 4004.339284018221, 5696.971515142398, 5697.943020569741, 5699.4300569944335, 5699.857503562278, 5708.086706127, 5449.427810079885, 5486.835394938158, 5491.697956612425, 5494.752736126964, 5501.229827824188, 5470.945290547203, 5478.233047373451, 5484.232207491034, 5489.670619762827, 5498.80754173602, 5236.031334203185, 5391.649542779707, 5391.892162156813, 5396.784128634968, 5398.4871437213405, 5536.307961504812, 5542.279503664659, 5545.556355491632, 5546.889062218814, 5549.916751248654, 5389.164679474688, 5390.4879036491475, 5394.811181608625, 5420.593455490775, 5427.728613569227], "unit": "ms", "name": "prototype.html", "value": 4143.981653736836}, {"lowerIsBetter": false, "replicates": [608.3521050081665, 646.8156575376016, 736.4366259811242, 738.3871386748997, 795.443189767163, 11959.521619135236, 12208.694782630417, 12229.143959922809, 12285.63143105706, 12292.078094142931, 11824.645260642174, 12259.448324825382, 12278.324692141929, 12287.38563071845, 12293.44679489423, 645.5835985789163, 654.0679531667355, 794.614611913223, 820.995895020524, 826.330672155553, 820.5199958024563, 826.7850358906668, 831.3889291370867, 831.9833603327929, 832.1512057701141, 861.9138086191363, 872.4459967920385, 872.764353624521, 873.4846440600045, 873.6680061576592, 667.7395815631908, 676.7191615479595, 844.252836239929, 857.9571021448903, 858.2919091749269, 634.4416913116474, 634.5748348606398, 634.6128861394545, 635.0125554762343, 635.6281575278422, 12156.209846359958, 12232.755344893141, 12234.81647775284, 12240.755184896341, 12250.938745306306, 10808.891911080867, 11280.717982050432, 11617.941910290394, 11830.112741544419, 11836.822447663291, 8729.825403491957, 8838.955805220998, 8846.115388461103, 8854.070322616097, 8888.333374996837, 3288.934221315584, 3350.0, 3357.2110554019787, 3363.7981721096567, 3364.327134573071, 39134.804325978475, 39148.80425597854, 39156.21687566233, 39160.0, 39178.412323815166, 9154.130357616015, 9346.439213647203, 9497.14525692691, 9818.165455936325, 10052.748681283027, 15903.602409939613, 16604.086775227235, 16629.168541573115, 16632.085235312174, 16655.83344166543, 6459.935400645933, 6492.902606460907, 6530.2816690164045, 6533.509986751013, 6782.525223234326, 3536.0806190390686, 3568.0544655666267, 3571.1250743567994, 3608.548931383577, 3659.817009149585, 2767.8200916940336, 2773.1264651635074, 2792.0367473221704, 2796.245013846291, 2798.2444739920516, 483.04598418124624, 483.784715801465, 490.4629430773297, 498.8328909815253, 504.5156649616336, 408.5914085914086, 419.6747520671504, 437.85769624872046, 460.94238220222474, 513.4172713969597, 6982.720691172296, 7129.607871567114, 7295.744648937261, 8391.622376992927, 8505.872411913826, 373.4566206170016, 432.55662945480503, 454.96360291176626, 477.34365247784297, 478.95109709735567, 3288.0, 3489.2323688788424, 3493.1092571394133, 3566.6433356664643, 3576.2668652926086, 49435.0, 50177.49822501801, 50545.0, 50661.493385065674, 50776.492235077916, 44089.77955110204, 44916.10167796626, 45401.0, 45413.318800218025, 45432.0, 41006.38490422646, 41244.1751164969, 41286.1742765149, 41606.375904361455, 41885.371719424234, 6906.723731050702, 6955.374016338554, 6971.790846274417, 7005.334493223136, 7172.390346820579, 29485.705142948296, 30215.546766798954, 30836.0, 30870.69129308678, 31346.68653313529, 39871.80064099661, 40291.798541007105, 40395.19209615733, 40505.59494405018, 40879.0, 9716.328344200167, 9969.750756230862, 9994.750131246486, 10201.948990255001, 10445.68662940113, 10528.78942421132, 10534.209934255116, 10731.409772462277, 10937.12502999774, 11009.889901100887, 10788.730281743019, 10895.455227238448, 11120.221584489009, 11141.0, 11788.528458861549, 10720.088792452418, 10770.13838892871, 10811.6215932442, 10884.61903833362, 11247.718807029889, 10783.0, 10827.783444330911, 10916.126709863032, 11181.737949088933, 11264.66206013821, 8823.161799629024, 8856.512891791013, 9110.362274640976, 9137.177654011171, 9406.247500200105, 8557.871631925402, 8745.387822852339, 8910.198082172636, 8911.866322005304, 8990.595423206103], "unit": "ms", "name": "yui.html", "value": 5647.1913901014095}], "name": "dromaeo_css", "value": 6203.38116892941}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 114.0, 107.0, 112.0, 111.0, 114.0, 104.0, 113.0, 113.0, 103.0], "unit": "ms", "name": "ai-astar", "value": 110.2}, {"lowerIsBetter": true, "replicates": [153.0, 132.0, 157.0, 173.0, 140.0, 164.0, 153.0, 132.0, 179.0, 134.0], "unit": "ms", "name": "audio-beat-detection", "value": 151.7}, {"lowerIsBetter": true, "replicates": [161.0, 161.0, 162.0, 161.0, 164.0, 161.0, 162.0, 162.0, 163.0, 163.0], "unit": "ms", "name": "audio-dft", "value": 162.0}, {"lowerIsBetter": true, "replicates": [73.0, 72.0, 81.0, 91.0, 73.0, 73.0, 71.0, 97.0, 91.0, 74.0], "unit": "ms", "name": "audio-fft", "value": 79.6}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 133.0, 94.0, 96.0, 95.0, 137.0, 95.0, 95.0, 129.0], "unit": "ms", "name": "audio-oscillator", "value": 106.4}, {"lowerIsBetter": true, "replicates": [110.0, 110.0, 109.0, 110.0, 109.0, 110.0, 109.0, 110.0, 111.0, 110.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 109.8}, {"lowerIsBetter": true, "replicates": [147.0, 147.0, 148.0, 146.0, 148.0, 147.0, 147.0, 147.0, 148.0, 147.0], "unit": "ms", "name": "imaging-darkroom", "value": 147.2}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 96.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0], "unit": "ms", "name": "imaging-desaturate", "value": 95.2}, {"lowerIsBetter": true, "replicates": [74.0, 74.0, 73.0, 72.0, 75.0, 73.0, 73.0, 82.0, 69.0, 70.0], "unit": "ms", "name": "json-parse-financial", "value": 73.5}, {"lowerIsBetter": true, "replicates": [67.0, 68.0, 68.0, 67.0, 68.0, 67.0, 68.0, 68.0, 67.0, 69.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 67.7}, {"lowerIsBetter": true, "replicates": [83.0, 83.0, 82.0, 92.0, 83.0, 84.0, 84.0, 95.0, 85.0, 84.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 85.5}, {"lowerIsBetter": true, "replicates": [134.0, 122.0, 120.0, 117.0, 124.0, 128.0, 124.0, 121.0, 126.0, 121.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 123.7}, {"lowerIsBetter": true, "replicates": [135.0, 146.0, 143.0, 144.0, 145.0, 144.0, 147.0, 145.0, 152.0, 140.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 144.1}, {"lowerIsBetter": true, "replicates": [70.0, 70.0, 69.0, 71.0, 70.0, 70.0, 70.0, 68.0, 70.0, 68.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 69.6}], "name": "kraken", "value": 1526.1999999999998}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [166.22340425531914], "unit": "score", "name": "Richards", "value": 212.37683199999995}, {"lowerIsBetter": false, "replicates": [186.74136321195144], "unit": "score", "name": "DeltaBlue", "value": 354.06189}, {"lowerIsBetter": false, "replicates": [278.2415136338342], "unit": "score", "name": "Encrypt", "value": 956.654514}, {"lowerIsBetter": false, "replicates": [5122.448979591837], "unit": "score", "name": "Decrypt", "value": 51.96362151394425}, {"lowerIsBetter": false, "replicates": [1976.2845849802372], "unit": "score", "name": "RayTrace", "value": 374.434434}, {"lowerIsBetter": false, "replicates": [791.1392405063291], "unit": "score", "name": "Earley", "value": 842.4092320000002}, {"lowerIsBetter": false, "replicates": [12219.512195121952], "unit": "score", "name": "Boyer", "value": 54.540884231536886}, {"lowerIsBetter": false, "replicates": [27648.64864864865], "unit": "score", "name": "RegExp", "value": 32.94862658846528}, {"lowerIsBetter": false, "replicates": [615.2905198776758], "unit": "score", "name": "Splay", "value": 132.4431262425448}, {"lowerIsBetter": false, "replicates": [4830.917874396136], "unit": "score", "name": "NavierStokes", "value": 307.1879999999999}], "name": "v8_7", "value": 19736.987703936353}]} 05:14:48 INFO - RETURN: dromaeo_css: 6203.38 05:14:48 INFO - RETURN: kraken: 1526.20 05:14:48 INFO - RETURN: v8_7: 19736.99 05:14:48 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,203,35]]", "result": "19736.99"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,203,35]]", "result": "1526.20"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,203,35]]", "result": "6203.38"}}} 05:14:48 INFO - Return code: 0 05:14:48 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 05:14:48 INFO - # TBPL SUCCESS # 05:14:48 INFO - Running post-action listener: _resource_record_post_action 05:14:48 INFO - Running post-run listener: _resource_record_post_run 05:14:50 INFO - Total resource usage - Wall time: 1234s; CPU: 13.0%; Read bytes: 262144; Write bytes: 520675328; Read time: 20; Write time: 580540 05:14:50 INFO - install - Wall time: 15s; CPU: 15.0%; Read bytes: 0; Write bytes: 245227520; Read time: 0; Write time: 374312 05:14:50 INFO - run-tests - Wall time: 1220s; CPU: 13.0%; Read bytes: 262144; Write bytes: 275128320; Read time: 20; Write time: 206196 05:14:50 INFO - Running post-run listener: _upload_blobber_files 05:14:50 INFO - Blob upload gear active. 05:14:50 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 05:14:50 INFO - Copying logs to upload dir... 05:14:50 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1269.931060 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 9 secs) (at 2015-12-10 05:14:49.026845) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-12-10 05:14:49.030635) ========= 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=61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010304 build_url: 'https://queue.taskcluster.net/v1/task/hTGMtL5SRuiaMKIQJem9Hg/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-12-10 05:14:49.082413) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-10 05:14:49.082756) ========= 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=61fa6ed41387771909ec0f71000001b3-1449748824.244695-1621841217 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004644 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-12-10 05:14:49.133193) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-10 05:14:49.133537) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-12-10 05:14:49.133850) ========= ========= Total master_lag: 0.28 =========