builder: mozilla-central_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-010 starttime: 1448281473.34 results: success (0) buildid: 20151123025628 builduid: 8f0f5eef549a45e1833e14b4a4f4b3e0 revision: 8b1fc0961a076e35646d0472a81feefc0074558c ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.337723) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.338096) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.338362) ========= 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=cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006543 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.360115) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.360381) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.374059) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.374341) ========= 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=cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004618 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.423318) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.423572) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.423898) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.424183) ========= 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=cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-23 04:24:34-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 43.7M=0s 2015-11-23 04:24:34 (43.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.181328 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.617552) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.617863) ========= 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=cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020579 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:33.668603) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-23 04:24:33.668956) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 8b1fc0961a076e35646d0472a81feefc0074558c --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 8b1fc0961a076e35646d0472a81feefc0074558c --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=cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-23 04:24:34,442 truncating revision to first 12 chars 2015-11-23 04:24:34,442 Setting DEBUG logging. 2015-11-23 04:24:34,442 attempt 1/10 2015-11-23 04:24:34,442 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/8b1fc0961a07?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-23 04:24:35,653 unpacking tar archive at: mozilla-central-8b1fc0961a07/testing/mozharness/ program finished with exit code 0 elapsedTime=1.518178 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-23 04:24:35.200444) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:35.200801) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:35.209467) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:35.209725) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-23 04:24:35.210114) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 12 secs) (at 2015-11-23 04:24:35.210390) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-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', 'Firefox-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-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=cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:24:36 INFO - MultiFileLogger online at 20151123 04:24:36 in /builds/slave/test 04:24:36 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 04:24:36 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:24:36 INFO - {'append_to_log': False, 04:24:36 INFO - 'base_work_dir': '/builds/slave/test', 04:24:36 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 04:24:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:24:36 INFO - 'branch': 'Firefox-Non-PGO', 04:24:36 INFO - 'buildbot_json_path': 'buildprops.json', 04:24:36 INFO - 'config_files': ('talos/linux_config.py',), 04:24:36 INFO - 'default_actions': ('clobber', 04:24:36 INFO - 'read-buildbot-config', 04:24:36 INFO - 'download-and-extract', 04:24:36 INFO - 'populate-webroot', 04:24:36 INFO - 'create-virtualenv', 04:24:36 INFO - 'install', 04:24:36 INFO - 'run-tests'), 04:24:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:24:36 INFO - 'download_minidump_stackwalk': True, 04:24:36 INFO - 'download_symbols': 'ondemand', 04:24:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:24:36 INFO - 'tooltool.py': '/tools/tooltool.py', 04:24:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:24:36 INFO - '/tools/misc-python/virtualenv.py')}, 04:24:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:24:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:24:36 INFO - 'installer_path': 'installer.exe', 04:24:36 INFO - 'log_level': 'info', 04:24:36 INFO - 'log_name': 'talos', 04:24:36 INFO - 'log_to_console': True, 04:24:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:24:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:24:36 INFO - 'opt_config_files': (), 04:24:36 INFO - 'pip_index': False, 04:24:36 INFO - 'sps_profile': False, 04:24:36 INFO - 'sps_profile_interval': 0, 04:24:36 INFO - 'suite': 'dromaeojs', 04:24:36 INFO - 'system_bits': '64', 04:24:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:24:36 INFO - 'title': 'talos-linux64-ix-010', 04:24:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:24:36 INFO - 'use_talos_json': True, 04:24:36 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:24:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:24:36 INFO - 'work_dir': 'build'} 04:24:36 INFO - ##### 04:24:36 INFO - ##### Running clobber step. 04:24:36 INFO - ##### 04:24:36 INFO - Running pre-action listener: _resource_record_pre_action 04:24:36 INFO - Running main action method: clobber 04:24:36 INFO - rmtree: /builds/slave/test/build 04:24:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:24:36 INFO - Running post-action listener: _resource_record_post_action 04:24:36 INFO - ##### 04:24:36 INFO - ##### Running read-buildbot-config step. 04:24:36 INFO - ##### 04:24:36 INFO - Running pre-action listener: _resource_record_pre_action 04:24:36 INFO - Running main action method: read_buildbot_config 04:24:36 INFO - Using buildbot properties: 04:24:36 INFO - { 04:24:36 INFO - "properties": { 04:24:36 INFO - "buildnumber": 328, 04:24:36 INFO - "product": "firefox", 04:24:36 INFO - "script_repo_revision": "production", 04:24:36 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 04:24:36 INFO - "repository": "", 04:24:36 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs", 04:24:36 INFO - "buildid": "20151123025628", 04:24:36 INFO - "slavename": "talos-linux64-ix-010", 04:24:36 INFO - "pgo_build": "False", 04:24:36 INFO - "basedir": "/builds/slave/test", 04:24:36 INFO - "project": "", 04:24:36 INFO - "platform": "ubuntu64_hw", 04:24:36 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 04:24:36 INFO - "slavebuilddir": "test", 04:24:36 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 04:24:36 INFO - "branch": "mozilla-central", 04:24:36 INFO - "repo_path": "mozilla-central", 04:24:36 INFO - "stage_platform": "linux64", 04:24:36 INFO - "builduid": "8f0f5eef549a45e1833e14b4a4f4b3e0", 04:24:36 INFO - "revision": "8b1fc0961a076e35646d0472a81feefc0074558c" 04:24:36 INFO - }, 04:24:36 INFO - "sourcestamp": { 04:24:36 INFO - "repository": "", 04:24:36 INFO - "hasPatch": false, 04:24:36 INFO - "project": "", 04:24:36 INFO - "branch": "mozilla-central-linux64-talos", 04:24:36 INFO - "changes": [ 04:24:36 INFO - { 04:24:36 INFO - "category": null, 04:24:36 INFO - "files": [ 04:24:36 INFO - { 04:24:36 INFO - "url": null, 04:24:36 INFO - "name": "https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 04:24:36 INFO - } 04:24:36 INFO - ], 04:24:36 INFO - "repository": "", 04:24:36 INFO - "rev": "8b1fc0961a076e35646d0472a81feefc0074558c", 04:24:36 INFO - "who": "cbook@mozilla.com", 04:24:36 INFO - "when": 1448281435, 04:24:36 INFO - "number": 6694646, 04:24:36 INFO - "comments": "merge fx-team to mozilla-central on a CLOSED TREE", 04:24:36 INFO - "project": "", 04:24:36 INFO - "at": "Mon 23 Nov 2015 04:23:55", 04:24:36 INFO - "branch": "mozilla-central-linux64-talos", 04:24:36 INFO - "revlink": "", 04:24:36 INFO - "properties": [ 04:24:36 INFO - [ 04:24:36 INFO - "buildid", 04:24:36 INFO - "20151123025628", 04:24:36 INFO - "Change" 04:24:36 INFO - ], 04:24:36 INFO - [ 04:24:36 INFO - "builduid", 04:24:36 INFO - "8f0f5eef549a45e1833e14b4a4f4b3e0", 04:24:36 INFO - "Change" 04:24:36 INFO - ], 04:24:36 INFO - [ 04:24:36 INFO - "pgo_build", 04:24:36 INFO - "False", 04:24:36 INFO - "Change" 04:24:36 INFO - ] 04:24:36 INFO - ], 04:24:36 INFO - "revision": "8b1fc0961a076e35646d0472a81feefc0074558c" 04:24:36 INFO - } 04:24:36 INFO - ], 04:24:36 INFO - "revision": "8b1fc0961a076e35646d0472a81feefc0074558c" 04:24:36 INFO - } 04:24:36 INFO - } 04:24:36 INFO - Found installer url https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 04:24:36 INFO - Running post-action listener: _resource_record_post_action 04:24:36 INFO - ##### 04:24:36 INFO - ##### Running download-and-extract step. 04:24:36 INFO - ##### 04:24:36 INFO - Running pre-action listener: _resource_record_pre_action 04:24:36 INFO - Running main action method: download_and_extract 04:24:36 INFO - mkdir: /builds/slave/test/build/tests 04:24:36 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:24:36 INFO - https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 04:24:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/test_packages.json 04:24:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/test_packages.json 04:24:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 04:24:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 04:24:38 INFO - Downloaded 1302 bytes. 04:24:38 INFO - Reading from file /builds/slave/test/build/test_packages.json 04:24:38 INFO - Using the following test package requirements: 04:24:38 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 04:24:38 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:24:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:24:38 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:24:38 INFO - u'jsshell-linux-x86_64.zip'], 04:24:38 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:24:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:24:38 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 04:24:38 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:24:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:24:38 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:24:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:24:38 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:24:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:24:38 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 04:24:38 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 04:24:38 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:24:38 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:24:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:24:38 INFO - https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:24:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:24:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:24:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/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:24:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/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:24:40 INFO - Downloaded 21339249 bytes. 04:24:40 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:24:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:24:40 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:24:41 INFO - Return code: 0 04:24:41 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 04:24: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:24:41 INFO - https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:24:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:24:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:24:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/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:24:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/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:24:49 INFO - Downloaded 21339249 bytes. 04:24:49 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:24:49 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 04:24:49 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:24:51 INFO - Return code: 0 04:24:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:24:51 INFO - https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:24:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 04:24:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 04:24:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/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:24:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/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:24:51 INFO - Downloaded 11130997 bytes. 04:24:51 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:24:51 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 04:24:51 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:24:52 INFO - Return code: 0 04:24:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:24:52 INFO - https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:24:52 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 04:24:52 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 04:24:52 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/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:24:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/5x-VBZGESPCn8UOyyItFsg/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:24:54 INFO - Downloaded 55911050 bytes. 04:24:54 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 04:24:54 INFO - mkdir: /builds/slave/test/properties 04:24:54 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:24:54 INFO - Writing to file /builds/slave/test/properties/build_url 04:24:54 INFO - Contents: 04:24:54 INFO - build_url:https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 04:24:54 INFO - Running post-action listener: _resource_record_post_action 04:24:54 INFO - Running post-action listener: set_extra_try_arguments 04:24:54 INFO - ##### 04:24:54 INFO - ##### Running populate-webroot step. 04:24:54 INFO - ##### 04:24:54 INFO - Running pre-action listener: _resource_record_pre_action 04:24:54 INFO - Running main action method: populate_webroot 04:24:54 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:24:54 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:24:54 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 04:24:54 INFO - '../fennec_ids.txt'], 04:24:54 INFO - 'tests': ['tcheck2']}, 04:24:54 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:24:54 INFO - '--tppagecycles', 04:24:54 INFO - '7'], 04:24:54 INFO - 'tests': ['tsvgm']}}, 04:24:54 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 04:24:54 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 04:24:54 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:24:54 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:24:54 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 04:24:54 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:24:54 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:24:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:24:54 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:24:54 INFO - 'talos_options': ['--e10s'], 04:24:54 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:24:54 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:24:54 INFO - 'tests': ['damp', 'tps']}, 04:24:54 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:24:54 INFO - 'talos_options': ['--e10s'], 04:24:54 INFO - 'tests': ['damp', 'tps']}, 04:24:54 INFO - 'g3': {'tests': ['dromaeo_dom']}, 04:24:54 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:24:54 INFO - 'other': {'tests': ['a11yr', 04:24:54 INFO - 'ts_paint', 04:24:54 INFO - 'tpaint', 04:24:54 INFO - 'sessionrestore', 04:24:54 INFO - 'sessionrestore_no_auto_restore']}, 04:24:54 INFO - 'other-e10s': {'talos_options': ['--e10s'], 04:24:54 INFO - 'tests': ['a11yr', 04:24:54 INFO - 'ts_paint', 04:24:54 INFO - 'tpaint', 04:24:54 INFO - 'sessionrestore', 04:24:54 INFO - 'sessionrestore_no_auto_restore']}, 04:24:54 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 04:24:54 INFO - 'tests': ['a11yr', 04:24:54 INFO - 'ts_paint', 04:24:54 INFO - 'tpaint', 04:24:54 INFO - 'sessionrestore', 04:24:54 INFO - 'sessionrestore_no_auto_restore']}, 04:24:54 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 04:24:54 INFO - 'tests': ['a11yr', 04:24:54 INFO - 'ts_paint', 04:24:54 INFO - 'tpaint', 04:24:54 INFO - 'sessionrestore', 04:24:54 INFO - 'sessionrestore_no_auto_restore']}, 04:24:54 INFO - 'other_l64': {'tests': ['a11yr', 04:24:54 INFO - 'ts_paint', 04:24:54 INFO - 'tpaint', 04:24:54 INFO - 'sessionrestore', 04:24:54 INFO - 'sessionrestore_no_auto_restore']}, 04:24:54 INFO - 'other_nol64': {'tests': ['a11yr', 04:24:54 INFO - 'ts_paint', 04:24:54 INFO - 'tpaint', 04:24:54 INFO - 'sessionrestore', 04:24:54 INFO - 'sessionrestore_no_auto_restore']}, 04:24:54 INFO - 'svgr': {'tests': ['tsvgx', 04:24:54 INFO - 'tsvgr_opacity', 04:24:54 INFO - 'tart', 04:24:54 INFO - 'tscrollx', 04:24:54 INFO - 'cart']}, 04:24:54 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 04:24:54 INFO - 'tests': ['tsvgx', 04:24:54 INFO - 'tsvgr_opacity', 04:24:54 INFO - 'tart', 04:24:54 INFO - 'tscrollx', 04:24:54 INFO - 'cart']}, 04:24:54 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:24:54 INFO - 'tests': ['tp5o']}, 04:24:54 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:24:54 INFO - 'talos_options': ['--e10s'], 04:24:54 INFO - 'tests': ['tp5o']}, 04:24:54 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:24:54 INFO - 'talos_options': ['--xperf_path', 04:24:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:24:54 INFO - 'tests': ['tp5n']}, 04:24:54 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:24:54 INFO - 'talos_options': ['--e10s', 04:24:54 INFO - '--xperf_path', 04:24:54 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:24:54 INFO - 'tests': ['tp5n']}}, 04:24:54 INFO - 'talos.zip': {'path': '', 04:24:54 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:24:54 INFO - Running post-action listener: _resource_record_post_action 04:24:54 INFO - ##### 04:24:54 INFO - ##### Running create-virtualenv step. 04:24:54 INFO - ##### 04:24:54 INFO - Running pre-action listener: _resource_record_pre_action 04:24:54 INFO - Running main action method: create_virtualenv 04:24:54 INFO - Creating virtualenv /builds/slave/test/build/venv 04:24:54 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:24:54 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:24:54 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:24:54 INFO - Using real prefix '/usr' 04:24:54 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:24:55 INFO - Installing distribute.............................................................................................................................................................................................done. 04:24:56 INFO - Installing pip.................done. 04:24:57 INFO - Return code: 0 04:24:57 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:24:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:24:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:24:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:24:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:24:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:24:57 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 0x7f8bc983ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222f6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22e0900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2326b70>, '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 0x2377dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2378250>, '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': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', '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:24:57 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:24:57 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:24:57 INFO - Using env: {'DISPLAY': ':0', 04:24:57 INFO - 'HOME': '/home/cltbld', 04:24:57 INFO - 'LANG': 'en_US.UTF-8', 04:24:57 INFO - 'LANGUAGE': 'en_US:en', 04:24:57 INFO - 'LOGNAME': 'cltbld', 04:24:57 INFO - 'MAIL': '/var/mail/cltbld', 04:24:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:24:57 INFO - 'MOZ_NO_REMOTE': '1', 04:24:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:24:57 INFO - 'NO_EM_RESTART': '1', 04:24:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:24:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:24:57 INFO - 'PWD': '/builds/slave/test', 04:24:57 INFO - 'SHELL': '/bin/bash', 04:24:57 INFO - 'SHLVL': '1', 04:24:57 INFO - 'TERM': 'linux', 04:24:57 INFO - 'TMOUT': '86400', 04:24:57 INFO - 'USER': 'cltbld', 04:24:57 INFO - 'XDG_SESSION_COOKIE': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', 04:24:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:24:57 INFO - '_': '/tools/buildbot/bin/python'} 04:24:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:24:57 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:24:57 INFO - Cleaning up... 04:24:57 INFO - Return code: 0 04:24:57 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 04:24:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:24:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:24:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:24:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:24:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:24:57 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 0x7f8bc983ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222f6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22e0900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2326b70>, '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 0x2377dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2378250>, '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': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', '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:24:57 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:24:57 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:24:57 INFO - Using env: {'DISPLAY': ':0', 04:24:57 INFO - 'HOME': '/home/cltbld', 04:24:57 INFO - 'LANG': 'en_US.UTF-8', 04:24:57 INFO - 'LANGUAGE': 'en_US:en', 04:24:57 INFO - 'LOGNAME': 'cltbld', 04:24:57 INFO - 'MAIL': '/var/mail/cltbld', 04:24:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:24:57 INFO - 'MOZ_NO_REMOTE': '1', 04:24:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:24:57 INFO - 'NO_EM_RESTART': '1', 04:24:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:24:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:24:57 INFO - 'PWD': '/builds/slave/test', 04:24:57 INFO - 'SHELL': '/bin/bash', 04:24:57 INFO - 'SHLVL': '1', 04:24:57 INFO - 'TERM': 'linux', 04:24:57 INFO - 'TMOUT': '86400', 04:24:57 INFO - 'USER': 'cltbld', 04:24:57 INFO - 'XDG_SESSION_COOKIE': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', 04:24:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:24:57 INFO - '_': '/tools/buildbot/bin/python'} 04:24:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:24:57 INFO - Downloading/unpacking psutil>=0.7.1 04:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:24:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:24:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:24:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:24:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:24:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:24:59 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 04:24:59 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 04:24:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:24:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:24:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:24:59 INFO - Installing collected packages: psutil 04:24:59 INFO - Running setup.py install for psutil 04:24:59 INFO - building 'psutil._psutil_linux' extension 04:24:59 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:24:59 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:24:59 INFO - building 'psutil._psutil_posix' extension 04:24:59 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:24:59 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:24:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:24:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:24:59 INFO - Successfully installed psutil 04:24:59 INFO - Cleaning up... 04:24:59 INFO - Return code: 0 04:24:59 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 04:24:59 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:24:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:24:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:24:59 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:24:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:24:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:24:59 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 0x7f8bc983ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222f6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22e0900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2326b70>, '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 0x2377dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2378250>, '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': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', '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:24:59 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:24:59 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:24:59 INFO - Using env: {'DISPLAY': ':0', 04:24:59 INFO - 'HOME': '/home/cltbld', 04:24:59 INFO - 'LANG': 'en_US.UTF-8', 04:24:59 INFO - 'LANGUAGE': 'en_US:en', 04:24:59 INFO - 'LOGNAME': 'cltbld', 04:24:59 INFO - 'MAIL': '/var/mail/cltbld', 04:24:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:24:59 INFO - 'MOZ_NO_REMOTE': '1', 04:24:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:24:59 INFO - 'NO_EM_RESTART': '1', 04:24:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:24:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:24:59 INFO - 'PWD': '/builds/slave/test', 04:24:59 INFO - 'SHELL': '/bin/bash', 04:24:59 INFO - 'SHLVL': '1', 04:24:59 INFO - 'TERM': 'linux', 04:24:59 INFO - 'TMOUT': '86400', 04:24:59 INFO - 'USER': 'cltbld', 04:24:59 INFO - 'XDG_SESSION_COOKIE': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', 04:24:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:24:59 INFO - '_': '/tools/buildbot/bin/python'} 04:24:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:24:59 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 04:24: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:24: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:24: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:24: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:24: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:24: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:25:01 INFO - Downloading mozsystemmonitor-0.0.tar.gz 04:25:01 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 04:25:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:25:01 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:25:01 INFO - Installing collected packages: mozsystemmonitor 04:25:01 INFO - Running setup.py install for mozsystemmonitor 04:25:01 INFO - Successfully installed mozsystemmonitor 04:25:01 INFO - Cleaning up... 04:25:01 INFO - Return code: 0 04:25:01 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:25:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:25:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:25:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:25:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:25:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:25:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:25:01 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 0x7f8bc983ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222f6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22e0900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2326b70>, '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 0x2377dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2378250>, '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': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', '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:25:01 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:25:01 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:25:01 INFO - Using env: {'DISPLAY': ':0', 04:25:01 INFO - 'HOME': '/home/cltbld', 04:25:01 INFO - 'LANG': 'en_US.UTF-8', 04:25:01 INFO - 'LANGUAGE': 'en_US:en', 04:25:01 INFO - 'LOGNAME': 'cltbld', 04:25:01 INFO - 'MAIL': '/var/mail/cltbld', 04:25:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:25:01 INFO - 'MOZ_NO_REMOTE': '1', 04:25:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:25:01 INFO - 'NO_EM_RESTART': '1', 04:25:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:25:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:25:01 INFO - 'PWD': '/builds/slave/test', 04:25:01 INFO - 'SHELL': '/bin/bash', 04:25:01 INFO - 'SHLVL': '1', 04:25:01 INFO - 'TERM': 'linux', 04:25:01 INFO - 'TMOUT': '86400', 04:25:01 INFO - 'USER': 'cltbld', 04:25:01 INFO - 'XDG_SESSION_COOKIE': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', 04:25:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:25:01 INFO - '_': '/tools/buildbot/bin/python'} 04:25:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:25:02 INFO - Downloading/unpacking blobuploader==1.2.4 04:25:02 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:25:02 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:25:02 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:25:02 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:25:02 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:25:02 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:25:03 INFO - Downloading blobuploader-1.2.4.tar.gz 04:25:03 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 04:25:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:25:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:25:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:25:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:25:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:25:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:25:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:25:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:25:04 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 04:25:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:25:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:25:04 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:25:04 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:25:04 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:25:04 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:25:04 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:25:04 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:25:04 INFO - Downloading docopt-0.6.1.tar.gz 04:25:04 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 04:25:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:25:04 INFO - Installing collected packages: blobuploader, requests, docopt 04:25:04 INFO - Running setup.py install for blobuploader 04:25:04 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:25:04 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:25:04 INFO - Running setup.py install for requests 04:25:04 INFO - Running setup.py install for docopt 04:25:04 INFO - Successfully installed blobuploader requests docopt 04:25:04 INFO - Cleaning up... 04:25:05 INFO - Return code: 0 04:25:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:25: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:25:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:25:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:25: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:25:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:25:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:25:05 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 0x7f8bc983ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222f6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22e0900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2326b70>, '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 0x2377dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2378250>, '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': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', '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:25:05 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:25:05 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:25:05 INFO - Using env: {'DISPLAY': ':0', 04:25:05 INFO - 'HOME': '/home/cltbld', 04:25:05 INFO - 'LANG': 'en_US.UTF-8', 04:25:05 INFO - 'LANGUAGE': 'en_US:en', 04:25:05 INFO - 'LOGNAME': 'cltbld', 04:25:05 INFO - 'MAIL': '/var/mail/cltbld', 04:25:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:25:05 INFO - 'MOZ_NO_REMOTE': '1', 04:25:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:25:05 INFO - 'NO_EM_RESTART': '1', 04:25:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:25:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:25:05 INFO - 'PWD': '/builds/slave/test', 04:25:05 INFO - 'SHELL': '/bin/bash', 04:25:05 INFO - 'SHLVL': '1', 04:25:05 INFO - 'TERM': 'linux', 04:25:05 INFO - 'TMOUT': '86400', 04:25:05 INFO - 'USER': 'cltbld', 04:25:05 INFO - 'XDG_SESSION_COOKIE': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', 04:25:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:25:05 INFO - '_': '/tools/buildbot/bin/python'} 04:25:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:25:05 INFO - Running setup.py (path:/tmp/pip-vJysv3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:25:05 INFO - Running setup.py (path:/tmp/pip-zmMND1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:25:05 INFO - Running setup.py (path:/tmp/pip-TO7Fkx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:25:05 INFO - Running setup.py (path:/tmp/pip-FVLbfQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:25:05 INFO - Running setup.py (path:/tmp/pip-PBl7sZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:25:05 INFO - Running setup.py (path:/tmp/pip-7t8CIV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:25:05 INFO - Running setup.py (path:/tmp/pip-Pbhe0a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:25:05 INFO - Running setup.py (path:/tmp/pip-JDB2x9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:25:05 INFO - Running setup.py (path:/tmp/pip-_3CCAA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:25:05 INFO - Running setup.py (path:/tmp/pip-wAo7nR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:25:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:25:05 INFO - Running setup.py (path:/tmp/pip-MJNCW1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:25:06 INFO - Running setup.py (path:/tmp/pip-Jfzkax-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:25:06 INFO - Running setup.py (path:/tmp/pip-1q_KkZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:25:06 INFO - Running setup.py (path:/tmp/pip-3ssdQq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:25:06 INFO - Running setup.py (path:/tmp/pip-n8dIbf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:25:06 INFO - Running setup.py (path:/tmp/pip-JQbMaJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:25:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:25:06 INFO - Running setup.py (path:/tmp/pip-TPsoYb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:25:06 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:25:06 INFO - Running setup.py install for manifestparser 04:25:06 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:25:06 INFO - Running setup.py install for mozcrash 04:25:06 INFO - Running setup.py install for mozdebug 04:25:06 INFO - Running setup.py install for mozdevice 04:25:06 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:25:06 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:25:06 INFO - Running setup.py install for mozfile 04:25:06 INFO - Running setup.py install for mozhttpd 04:25:07 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Running setup.py install for mozinfo 04:25:07 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Running setup.py install for mozInstall 04:25:07 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Running setup.py install for mozleak 04:25:07 INFO - Running setup.py install for mozlog 04:25:07 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Running setup.py install for moznetwork 04:25:07 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Running setup.py install for mozprocess 04:25:07 INFO - Running setup.py install for mozprofile 04:25:07 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Running setup.py install for mozrunner 04:25:07 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:25:07 INFO - Running setup.py install for mozscreenshot 04:25:08 INFO - Running setup.py install for moztest 04:25:08 INFO - Running setup.py install for mozversion 04:25:08 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:25:08 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:25:08 INFO - Cleaning up... 04:25:08 INFO - Return code: 0 04:25:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:25: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:25:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:25:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:25: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:25:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:25:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:25: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/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 0x7f8bc983ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222f6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22e0900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2326b70>, '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 0x2377dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2378250>, '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': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', '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:25: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/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:25: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/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:25:08 INFO - Using env: {'DISPLAY': ':0', 04:25:08 INFO - 'HOME': '/home/cltbld', 04:25:08 INFO - 'LANG': 'en_US.UTF-8', 04:25:08 INFO - 'LANGUAGE': 'en_US:en', 04:25:08 INFO - 'LOGNAME': 'cltbld', 04:25:08 INFO - 'MAIL': '/var/mail/cltbld', 04:25:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:25:08 INFO - 'MOZ_NO_REMOTE': '1', 04:25:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:25:08 INFO - 'NO_EM_RESTART': '1', 04:25:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:25:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:25:08 INFO - 'PWD': '/builds/slave/test', 04:25:08 INFO - 'SHELL': '/bin/bash', 04:25:08 INFO - 'SHLVL': '1', 04:25:08 INFO - 'TERM': 'linux', 04:25:08 INFO - 'TMOUT': '86400', 04:25:08 INFO - 'USER': 'cltbld', 04:25:08 INFO - 'XDG_SESSION_COOKIE': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', 04:25:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:25:08 INFO - '_': '/tools/buildbot/bin/python'} 04:25:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:25:08 INFO - Running setup.py (path:/tmp/pip-Vv2CzB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:25:08 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:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:25:08 INFO - Running setup.py (path:/tmp/pip-zxr5YY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:25:08 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:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:25:08 INFO - Running setup.py (path:/tmp/pip-Qtr2x6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:25:08 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:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:25:08 INFO - Running setup.py (path:/tmp/pip-EEDYfV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:25:08 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:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:25:08 INFO - Running setup.py (path:/tmp/pip-AV5fXN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:25:08 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:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:25:08 INFO - Running setup.py (path:/tmp/pip-hdSk0Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:25:08 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:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:25:08 INFO - Running setup.py (path:/tmp/pip-IHc7b_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:25:08 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:25:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:25:08 INFO - Running setup.py (path:/tmp/pip-wnZiM5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:25:09 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:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:25:09 INFO - Running setup.py (path:/tmp/pip-4Ufkej-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:25:09 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:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:25:09 INFO - Running setup.py (path:/tmp/pip-vwKEOC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:25:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:25:09 INFO - Running setup.py (path:/tmp/pip-mIBRje-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:25:09 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:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:25:09 INFO - Running setup.py (path:/tmp/pip-lsLzyt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:25:09 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:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:25:09 INFO - Running setup.py (path:/tmp/pip-KeNXnT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:25:09 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:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:25:09 INFO - Running setup.py (path:/tmp/pip-z_50M6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:25:09 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:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:25:09 INFO - Running setup.py (path:/tmp/pip-8Wfc_n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:25:09 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:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:25:09 INFO - Running setup.py (path:/tmp/pip-FXuiNh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:25:09 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:25:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:25:09 INFO - Running setup.py (path:/tmp/pip-2icXtN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:25:09 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:25:09 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:25: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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:25:09 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:25:09 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:25:09 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:25:09 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:25: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:25: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:25: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:25: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:25: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:25: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:25:11 INFO - Downloading blessings-1.5.1.tar.gz 04:25:11 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:25:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:25:11 INFO - Installing collected packages: blessings 04:25:11 INFO - Running setup.py install for blessings 04:25:11 INFO - Successfully installed blessings 04:25:11 INFO - Cleaning up... 04:25:11 INFO - Return code: 0 04:25:11 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:25:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:25:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:25:11 INFO - Reading from file tmpfile_stdout 04:25:11 INFO - Current package versions: 04:25:11 INFO - argparse == 1.2.1 04:25:11 INFO - blessings == 1.5.1 04:25:11 INFO - blobuploader == 1.2.4 04:25:11 INFO - docopt == 0.6.1 04:25:11 INFO - manifestparser == 1.1 04:25:11 INFO - mozInstall == 1.12 04:25:11 INFO - mozcrash == 0.16 04:25:11 INFO - mozdebug == 0.1 04:25:11 INFO - mozdevice == 0.47 04:25:11 INFO - mozfile == 1.2 04:25:11 INFO - mozhttpd == 0.7 04:25:11 INFO - mozinfo == 0.9 04:25:11 INFO - mozleak == 0.1 04:25:11 INFO - mozlog == 3.0 04:25:11 INFO - moznetwork == 0.27 04:25:11 INFO - mozprocess == 0.22 04:25:11 INFO - mozprofile == 0.27 04:25:11 INFO - mozrunner == 6.11 04:25:11 INFO - mozscreenshot == 0.1 04:25:11 INFO - mozsystemmonitor == 0.0 04:25:11 INFO - moztest == 0.7 04:25:11 INFO - mozversion == 1.4 04:25:11 INFO - psutil == 3.1.1 04:25:11 INFO - requests == 1.2.3 04:25:11 INFO - wsgiref == 0.1.2 04:25:11 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:25: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:25:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:25:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:25: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:25:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:25:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:25: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', '-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 0x7f8bc983ac70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x222f6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22e0900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2326b70>, '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 0x2377dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2378250>, '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': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', '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:25:11 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:25:11 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:25:11 INFO - Using env: {'DISPLAY': ':0', 04:25:11 INFO - 'HOME': '/home/cltbld', 04:25:11 INFO - 'LANG': 'en_US.UTF-8', 04:25:11 INFO - 'LANGUAGE': 'en_US:en', 04:25:11 INFO - 'LOGNAME': 'cltbld', 04:25:11 INFO - 'MAIL': '/var/mail/cltbld', 04:25:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:25:11 INFO - 'MOZ_NO_REMOTE': '1', 04:25:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:25:11 INFO - 'NO_EM_RESTART': '1', 04:25:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:25:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:25:11 INFO - 'PWD': '/builds/slave/test', 04:25:11 INFO - 'SHELL': '/bin/bash', 04:25:11 INFO - 'SHLVL': '1', 04:25:11 INFO - 'TERM': 'linux', 04:25:11 INFO - 'TMOUT': '86400', 04:25:11 INFO - 'USER': 'cltbld', 04:25:11 INFO - 'XDG_SESSION_COOKIE': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', 04:25:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:25:11 INFO - '_': '/tools/buildbot/bin/python'} 04:25:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:25:12 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:25:12 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:25:12 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:25:12 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:25:12 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:25:12 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:25:12 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:25:12 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:25:12 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:25:12 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:25:12 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:25:12 INFO - Cleaning up... 04:25:12 INFO - Return code: 0 04:25:12 INFO - Running post-action listener: _resource_record_post_action 04:25:12 INFO - Running post-action listener: _start_resource_monitoring 04:25:12 INFO - Starting resource monitoring. 04:25:12 INFO - ##### 04:25:12 INFO - ##### Running install step. 04:25:12 INFO - ##### 04:25:12 INFO - Running pre-action listener: _resource_record_pre_action 04:25:12 INFO - Running main action method: install 04:25:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:25:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:25:12 INFO - Reading from file tmpfile_stdout 04:25:12 INFO - Detecting whether we're running mozinstall >=1.0... 04:25:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:25:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:25:12 INFO - Reading from file tmpfile_stdout 04:25:12 INFO - Output received: 04:25:12 INFO - Usage: mozinstall [options] installer 04:25:12 INFO - Options: 04:25:12 INFO - -h, --help show this help message and exit 04:25:12 INFO - -d DEST, --destination=DEST 04:25:12 INFO - Directory to install application into. [default: 04:25:12 INFO - "/builds/slave/test"] 04:25:12 INFO - --app=APP Application being installed. [default: firefox] 04:25:12 INFO - mkdir: /builds/slave/test/build/application 04:25:12 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:25:12 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:25:26 INFO - Reading from file tmpfile_stdout 04:25:26 INFO - Output received: 04:25:26 INFO - /builds/slave/test/build/application/firefox/firefox 04:25:26 INFO - Running post-action listener: _resource_record_post_action 04:25:26 INFO - ##### 04:25:26 INFO - ##### Running run-tests step. 04:25:26 INFO - ##### 04:25:26 INFO - Running pre-action listener: _resource_record_pre_action 04:25:26 INFO - Running main action method: run_tests 04:25:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:25:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:25:26 INFO - Python 2.7.3 04:25:26 INFO - Return code: 0 04:25:26 INFO - grabbing minidump binary from tooltool 04:25:26 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:25:26 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 0x2326b70>, '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 0x2377dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2378250>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:25:26 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:25:26 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:25:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:25:26 INFO - Return code: 0 04:25:26 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:25:26 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:25:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:25:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:25:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:25:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-010', '--webServer', 'localhost'] in /builds/slave/test/build 04:25:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Firefox-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-010 --webServer localhost 04:25:26 INFO - Using env: {'DISPLAY': ':0', 04:25:26 INFO - 'HOME': '/home/cltbld', 04:25:26 INFO - 'LANG': 'en_US.UTF-8', 04:25:26 INFO - 'LANGUAGE': 'en_US:en', 04:25:26 INFO - 'LOGNAME': 'cltbld', 04:25:26 INFO - 'MAIL': '/var/mail/cltbld', 04:25:26 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:25:26 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:25:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:25:26 INFO - 'MOZ_NO_REMOTE': '1', 04:25:26 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:25:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:25:26 INFO - 'NO_EM_RESTART': '1', 04:25:26 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:25:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:25:26 INFO - 'PWD': '/builds/slave/test', 04:25:26 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:25:26 INFO - 'SHELL': '/bin/bash', 04:25:26 INFO - 'SHLVL': '1', 04:25:26 INFO - 'TERM': 'linux', 04:25:26 INFO - 'TMOUT': '86400', 04:25:26 INFO - 'USER': 'cltbld', 04:25:26 INFO - 'XDG_SESSION_COOKIE': 'cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391', 04:25:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:25:26 INFO - '_': '/tools/buildbot/bin/python'} 04:25:26 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-010', '--webServer', 'localhost'] with output_timeout 3600 04:25:26 INFO - mozversion INFO | application_buildid: 20151123025628 04:25:26 INFO - mozversion INFO | application_changeset: 8b1fc0961a076e35646d0472a81feefc0074558c 04:25:26 INFO - mozversion INFO | application_display_name: Nightly 04:25:26 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:25:26 INFO - mozversion INFO | application_name: Firefox 04:25:26 INFO - mozversion INFO | application_remotingname: firefox 04:25:26 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/mozilla-central 04:25:26 INFO - mozversion INFO | application_vendor: Mozilla 04:25:26 INFO - mozversion INFO | application_version: 45.0a1 04:25:26 INFO - mozversion INFO | platform_buildid: 20151123025628 04:25:26 INFO - mozversion INFO | platform_changeset: 8b1fc0961a076e35646d0472a81feefc0074558c 04:25:26 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/mozilla-central 04:25:26 INFO - mozversion INFO | platform_version: 45.0a1 04:25:26 INFO - 2015-11-23 04:25:26,797 DEBUG : using testdate: 1448281526 04:25:26 INFO - 2015-11-23 04:25:26,797 DEBUG : actual date: 1448281526 04:25:26 INFO - 2015-11-23 04:25:26,807 INFO : starting webserver on 'localhost:36145' 04:25:26 INFO - 2015-11-23 04:25:26,808 INFO : Starting test suite talos-linux64-ix-010 04:25:26 INFO - 2015-11-23 04:25:26,808 INFO : Starting test dromaeo_css 04:25:26 INFO - 2015-11-23 04:25:26,808 DEBUG : operating with platform_type : linux_ 04:25:26 INFO - 2015-11-23 04:25:26,809 INFO : Initialising browser for dromaeo_css test... 04:25:26 INFO - 2015-11-23 04:25:26,824 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZkHS7U/profile http://localhost:36145/getInfo.html 04:25:31 INFO - 2015-11-23 04:25:31,710 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 04:25:31 INFO - 2015-11-23 04:25:31,710 DEBUG : BROWSER_OUTPUT: colorDepth:24 04:25:31 INFO - 2015-11-23 04:25:31,710 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 04:25:31 INFO - 2015-11-23 04:25:31,710 DEBUG : BROWSER_OUTPUT: __metrics 04:25:31 INFO - 2015-11-23 04:25:31,913 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:25:33 INFO - 2015-11-23 04:25:33,044 INFO : Browser initialized. 04:25:33 INFO - 2015-11-23 04:25:33,045 INFO : Running cycle 1/1 for dromaeo_css test... 04:25:33 INFO - 2015-11-23 04:25:33,045 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpZkHS7U/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 04:25:44 INFO - 2015-11-23 04:25:44,963 DEBUG : BROWSER_OUTPUT: RSS: Main: 140083200 04:25:44 INFO - 2015-11-23 04:25:44,963 DEBUG : BROWSER_OUTPUT: 04:26:36 INFO - 2015-11-23 04:26:36,435 DEBUG : BROWSER_OUTPUT: 1448281596432 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:28:48 INFO - 2015-11-23 04:28:48,853 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/dromaeo/cssquery-dojo.html (next: http://localhost:36145/tests/dromaeo/cssquery-ext.html) 04:28:50 INFO - 2015-11-23 04:28:50,023 DEBUG : BROWSER_OUTPUT: RSS: Main: 244973568 04:28:50 INFO - 2015-11-23 04:28:50,023 DEBUG : BROWSER_OUTPUT: 04:31:52 INFO - 2015-11-23 04:31:52,559 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/dromaeo/cssquery-ext.html (next: http://localhost:36145/tests/dromaeo/cssquery-jquery.html) 04:31:53 INFO - 2015-11-23 04:31:53,141 DEBUG : BROWSER_OUTPUT: RSS: Main: 226058240 04:31:53 INFO - 2015-11-23 04:31:53,141 DEBUG : BROWSER_OUTPUT: 04:34:55 INFO - 2015-11-23 04:34:55,276 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/dromaeo/cssquery-jquery.html (next: http://localhost:36145/tests/dromaeo/cssquery-mootools.html) 04:34:55 INFO - 2015-11-23 04:34:55,837 DEBUG : BROWSER_OUTPUT: RSS: Main: 209588224 04:34:55 INFO - 2015-11-23 04:34:55,837 DEBUG : BROWSER_OUTPUT: 04:37:57 INFO - 2015-11-23 04:37:57,779 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/dromaeo/cssquery-mootools.html (next: http://localhost:36145/tests/dromaeo/cssquery-prototype.html) 04:37:58 INFO - 2015-11-23 04:37:58,381 DEBUG : BROWSER_OUTPUT: RSS: Main: 200740864 04:37:58 INFO - 2015-11-23 04:37:58,381 DEBUG : BROWSER_OUTPUT: 04:41:01 INFO - 2015-11-23 04:41:01,168 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/dromaeo/cssquery-prototype.html (next: http://localhost:36145/tests/dromaeo/cssquery-yui.html) 04:41:01 INFO - 2015-11-23 04:41:01,772 DEBUG : BROWSER_OUTPUT: RSS: Main: 203800576 04:41:01 INFO - 2015-11-23 04:41:01,772 DEBUG : BROWSER_OUTPUT: 04:44:04 INFO - 2015-11-23 04:44:04,725 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/dromaeo/cssquery-yui.html (next: http://localhost:36145/tests/dromaeo/cssquery-dojo.html) 04:44:04 INFO - 2015-11-23 04:44:04,975 DEBUG : BROWSER_OUTPUT: RSS: Main: 263823360 04:44:04 INFO - 2015-11-23 04:44:04,975 DEBUG : BROWSER_OUTPUT: 04:44:04 INFO - 2015-11-23 04:44:04,978 DEBUG : BROWSER_OUTPUT: __start_tp_report 04:44:04 INFO - 2015-11-23 04:44:04,978 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 04:44:04 INFO - 2015-11-23 04:44:04,979 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 04:44:04 INFO - 2015-11-23 04:44:04,979 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 04:44:04 INFO - 2015-11-23 04:44:04,979 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2653.694825095114;2732.9863350683245;2742;2753.7246275372463;2761.9723802761973;4512.187806194892;4649.093426781779;4702.388689470368;4757.262624293231;4762.428508578967;4633.791479383427;4665.6500762442865;4683.50823163568;4685.929711054337;4689.507601701824;4280.464941882265;4314.1803057419065;4365.039691267916;4506.594406503414;4534.047849951514;4207.221663992172;4422.159789639974;4455.108978204372;4540.250858608326;4543.136804007245;4217.6204141627095;4281.464816897887;4298.892527686801;4328.545502722201;4347.891302717426;4415.779211039435;4416.094700586372;4423.049044455425;4427.446569178853;4446.955530444687;4394.648428125743;4403.559644035603;4403.889902752425;4412.117576484716;4425.225585522553;4488.5960263576435;4602.470715867685;4604.125216208943;4612.100640375128;4722.472901811822;5035.244713292998;5042.268871013719;5044.747762611892;5045.873853153664;5050.3434553507805;5068.5691716204165;5071.39143302806;5081.212412076134;5084.491550844923;5086.287919691246;4619.699719518254;4663.51033141522;4675.95324046762;4681;4711.1284412383475;5187.740612969336;5238.371395432572;5244.763985620656;5247.7667748079175;5269.394019687708;4766.904661906742;4872.439669437989;4872.585830204402;5044.319016932741;5086.847394578169;5038.143515602356;5110.744462776846;5144.6913185209005;5151.278820965068;5202.817901373433;4987.875303117378;4994.850154495371;4995.975020124949;4997.900041999213;5032.496750324938;4804.447488538793;4919.877003074952;4923.655344125948;4947.208446648519;4995.875103122451;4174.332106862948;4254.532001479834;4258.339957306623;4280.586299730743;4297.613214810682;3717.442383642421;3723.5717892442176;3728.3102626014274;3754.887353379403;3760.341940160461;4232;4328.091100868853;4330.372096046056;4399.6040356368085;4414.359917811899;5077.466865979093;5079.5428411443145;5129.948700512947;5200.6879587224885;5201.687898726089;4400.471943366816;4416.823327066945;4424.0709451015;4433.689641725048;4457.286834106528;4333.71830830995;4549.294859296814;4567.223571992769;4572.657050721143;4605.815767369335;4740.620750340034;4740.928886066712;4746.501617330268;4758.119747846659;4865.929495510982;5160.200168973815;5163;5164.638475306692;5167.92248116271;5169.870753231199;4872.561469467765;4876.683015603974;4879.634027447884;4880.487548807324;4931.358923340086;4773.522647735199;4832.251001094836;4891.9971405861;4898.975505122452;5090.211017292326;5106.234064890147;5111.923321150261;5144.871378215575;5200.895982080261;5202.063628546898;4924.089043526959;4926.261060840902;4932.556069953722;4932.901341973212;4935.062338155739;4721.055788842314;4847.2729090636685;4931.753412329297;4939.456659767351;4979.377577802775;4766.928496072493;4804.495527969652;4822.7829747660735;4886.53577910098;4912.263160525949;4979.103761322996;4998.2002879539095;4999.925001124913;5012.573931215888;5038.445770965264;4875.3174555562955;4876.366072410564;4878.878028049186;4879.463259041431;4917.360743103373 04:44:04 INFO - 2015-11-23 04:44:04,979 DEBUG : BROWSER_OUTPUT: |1;ext.html;554.7420449490988;562.0809975689746;575.4418214332097;585.721782153477;585.8330375842883;27697.861510692444;34113.488297675525;34245.45895434705;34331;34367.484487732676;39863;40032.59967400325;40230.396544051866;40403.59596404035;40440.39339409904;6758.22280437751;7134.500584959055;7516.323530882206;7630.351420129296;7657.923420765805;10069.64756233532;10310.381377117359;10320.483975801217;10321.277510574262;10344.948275258614;9874.703758887208;9875.209983201326;9934.205263578897;9969.451680157625;9969.800603987916;7160.104986876667;7311.1592166900955;9654.951725241364;10152.746181345525;10404.375737455777;9846.458444785534;9988.400695958266;9991.500424978722;9992.200623950066;9996.50017499122;37599.62400376016;38089;38105.23789524194;38107.8094609528;38125.428118578246;2946.6905974872543;2982.7762917781038;3005.068428787083;3414.8551175536327;3634.872779452733;28677.13968580946;28734.425311493862;28817.34331104103;29126.854365728246;29327.187569697504;3045.8629361678777;3066.156806878104;3114.7508199343997;3211.550382946389;3213.1806389370795;227051;227605;227821;228373;294510.99999999785;43294.35058474125;52067;52410.475895241325;52767.73616131895;52958;53414.465855341725;53591.464085358646;53787;53825;53888;11846;11881.287122772661;11955.52177912891;11959.461824217931;12013.699657508458;9560.617575297048;9562.521873906417;9578.664746733832;9648.276379271583;9668.661596844217;17713.645727085386;17854.55363615894;17891.1948962297;17893.552661183316;17944.461666150037;7487.962560187164;7691.50005249657;7702.422318326148;7703.114141873756;7817.335526480313;780.8867714181412;832.5337810825957;906.9637214511478;908.2234689340651;993.1210878372692;26122;26485.73514264871;26510.44845741994;26807.731922680912;26869.731302686723;936.0265324063034;943.9363539960399;949.9145076943108;957.1816097236763;995.3381001633977;13763.243021633705;13777.724445511034;13914.652133696738;13915;14017.649558760908;276299;278721;280422;281402;281561;45963.54036459592;46160.076798463844;46165.5383446168;46171.76914115408;46276.305855412196;1064.685917654294;1109.0905457524752;1175.1949914308555;1180.0677464802882;1271.0467149637773;25547.872260638578;26217.34456638523;26770.598441023012;27093.1872043839;27110;35632.28735425329;35787.82106089453;36171.819140904125;36445.27109457743;36955.26089478249;319137;326056;326219;326352;327269;26803;27326.5901011481;27344.179674609793;27369.45261094807;27381.86309068442;36920;37421.625783741816;37736.81131594325;37781;38191.61808381881;30745.846270768503;32136.83931580327;32681.18297042593;32704.889550757012;33133.33733325272;32417;32734.34531309408;32956.50565241571;33080.66919330776;33191.336173275915;31963.840180798947;33051.17372065622;33202.667973319956;33295;33323.333533329685;27860.249362114042;29653.555196671634;29830.552541712324;29849.403011940074;30083;23009.589402392186;23407.53184936326;23445.296641100795;23550.646740298565;23654.88172559126 04:44:04 INFO - 2015-11-23 04:44:04,979 DEBUG : BROWSER_OUTPUT: |2;jquery.html;343.5653897819258;344.0572830444582;345.1602956243223;345.6422602606303;348.122730718589;12019.399030048484;12321.938390308058;14896.5531034069;15192.468263610775;16792.832071679295;12357.629271121881;14763.261836908165;14972;15034.699306013874;15046.322915468803;3060.219643990785;3512.964870351302;3523.8061906595126;3543.6279190684995;5025.472325405816;3392.694657480826;3470.097774578615;5080.949190508103;5150.948490515103;5152.278680984665;5200.973995130019;5345.358556973169;5364.6781193128345;5366.248725178478;5376.569874410038;5216.843494695166;5328.147496400596;5329.120695085307;5332.786688532474;5359.437259087778;5129.717865517395;5153.510416510426;5157.329547158845;5160.48395160481;5161.354830646169;11741.060715142768;13005;17337.78635495516;19085;19116.33092841744;1809.2401191499603;1837.4946889605333;1921.3755529452983;1935.371004423568;1966.0759443061738;9053.818923621491;9391.859122113174;10547.103496202755;12701.555445559454;12977.480900763958;1796.0929730486152;1800.53186171595;1918.7121931710356;1957.7063440483898;2008.9196432142696;53590;55200;56042.71978640121;56530;57069.71465142689;9862.211023118134;9880.703578892644;9889.554970026365;9901.207903367713;9914;12452.190607610477;12457.626271211879;12473.126881118416;12483;12489;6710.060591517192;6717.261101278856;6721.361470660279;6755.459563234929;6770.8645827084165;6289.55973081889;6401.3278605746655;6401.7119229633845;6419.358064193637;6454.386833250834;4145.316022856195;4214.494260688737;4214.536400995888;4238.766867822238;4262.168877069003;1611.105836260863;1672.8828981971146;1688.451253342644;1718.321263101068;1723.414039226669;816.3061397811813;852.0627309958995;906.4833045164324;912.4890061565544;1004.2618675273668;15512.638258035471;15907.840921590867;16093.195340232942;16174.353025879069;16319.34722611106;763.5402121275112;793.2701914238914;840.2815592668303;854.2525290370926;873.816498535302;7635.961820190974;8612.956935215283;8676.566171691391;8794.296456283482;8808.647654093893;508449;511212;528387;528819;530178;70610.29389706037;70875.64562177156;72571.63714181501;73888.63055684687;76137.61931190308;1030.5620111452602;1049.6483677967967;1050.7478205230689;1056.7041228456044;1058.1059005140798;13738.725225495235;14201.644958876112;14222.928885355921;14397.568072957829;14401.42394304216;31649;32334.029979100666;32735;33680.83159584186;34268.82865585656;41738.373924391766;41888.581114189685;42149.789251053546;43221.78389108034;47503;8563.657453702031;8787;8933.240674542736;8940.418872773249;8943.642254309754;10487.475626218811;10497.212709047004;10502.632407865687;10515.94742026285;10644.361338319726;12263.877361226274;13480.123791953492;13782;13864.861351386357;13965.231912244924;11982.880171198176;11987.22083064598;12448.190867593577;12520.749585008067;12785.552505662257;12710.110292279453;13299;13775.106201785675;14109.29453527299;14176.929115354356;7068.151821781419;8137.430379873352;8755.474671519729;8767.079456656958;8936.508492033001;11733.589324373606;11948.34284114382;12240.693982650506;13287.202767833574;13380.799288010492 04:44:04 INFO - 2015-11-23 04:44:04,980 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1393;1424.7079348733512;1458.0376951212202;1550.5658415643625;1701.9234134463957;5939.52483801296;6650.733970641175;6778;6798.830029249271;6805.761798337059;6877.346652068058;6913.619750913697;6969.860602787941;6981.022656828048;6991.196012458556;2074.8132668059834;2102.55846272283;2103.14822496889;2103.7896210378995;2104.642210824156;1957.4421289932372;2091.623507768601;2100.28590279305;2104.2424727098232;2111.42991392324;2058.3516192399347;2087.7703452620276;2097.538541520863;2098.443912363225;2102.148629804924;2060.464279287381;2077.7714451410334;2079.5736873940805;2079.729635147436;2089.5716378142442;2024.9291274805312;2039.5716899451133;2049.846261530391;2051.4871282179456;2054.527458684496;5850.473457388813;6042.6978651067275;6851.07510486083;6891.483138764613;6892.069570607954;4125.5874412558505;4261.786910654455;4264.360345948102;4264.658827293809;4272.743635381887;2814.6622405311496;2822.6753923298675;2851.6720577133688;2852.2441552988475;2900.3329234276234;876.430320291809;876.7808047988003;877.9078196789372;889.0798024045082;907.2968449451728;9418.387804792666;9539.09378609038;9551;9552.665656701982;9569.138777509988;3873.9806300968316;3887.7667339959694;3925;3930.5872883346838;4007.338789099824;8237.711680091168;8243.340532757366;8250.133735957757;8251.546164960864;8267.379946504036;4299.376590394375;4303.2469317869245;4312.978435107867;4315.07225946423;4316.697831151852;3922.7057970652313;3922.823472943667;3928.3321835287497;3928.7053470989217;3934.252492026506;3296.9284982380823;3300.5709257796334;3319.4522903720617;3331.866725331008;3345.1637090727318;1093.781243751253;1096.5339730614617;1098.6374496416163;1104.320842681745;1112.5494174859195;896.1397058823602;980.612658000086;1146.0316032952142;1159.9014083802801;1168.1705988747915;6648.202215734143;6769.72921083161;6787.490938179656;6787.6266805325195;6788;1039.4906495817147;1052.4790228836775;1058.5765693722572;1077.2943721862193;1079.1959989807488;4852.223644216909;5241.528262456397;5300.1519756838725;5304.336957880265;5313.628046036741;7389.963050184715;8436.662533498591;8495;8495.872561911576;8513.212225432728;8203.876941845878;8262.380321475914;8324.417290789708;8327.875736775579;8333.291670207978;6406.775762848278;6599.703013364506;6603.867922641521;6643.7674681385915;6665.233498147678;6643.6144770408855;6645.036469711768;6707.832304192434;6710.429613482908;6714.429273511806;7514.248575142442;7532.585707786125;7605.6577454013595;7656.310932016146;7666.846663066596;7464.253574642492;7584.848303033798;7770.922290777246;7771;7774;6219.657918814328;6221.06683997404;6242.406971337716;6260.40526150015;6271.122042913905;6876.724931002704;6915.654217289015;6917.066196063467;6929.757458488929;6966.825829354104;6440.742370305323;6506.512011599244;6571;6625.900611490928;6650.667466626553;6317.7157027932935;6429.9678501607195;6432.324605916311;6546.312637173219;6568.47452203813;6377.521685873671;6428.646424446701;6437.034444833313;6438.066480360415;6446.613203207822;5811.099279611667;5923.614965027259;5924.822255332347;6018.8194354169445;6044.516438684983;5988.101784732325;6024.518038556993;6024.819255422169;6031.457168854824;6037.849053773691 04:44:04 INFO - 2015-11-23 04:44:04,982 DEBUG : BROWSER_OUTPUT: |4;prototype.html;312.65920147039725;316.0408161230665;317.13422356965486;317.51103300916577;318.7450039968025;5300.575953923687;5313.282706834576;5463.562914966803;5545.805896793608;5572.359178694452;5233.79064837407;5373.677579345242;5383.81156659517;5391.81128660497;5392.56859451244;4033.2135233629456;4126.669866410695;4209.768462734556;4216.810243539033;4219.936700949488;4121.072758629314;4214.704970652056;4216.599423054805;4221.662267018631;4224.704270701052;4165.146145040275;4171.103212809246;4174.582541745816;4181.0592616661315;4189.79051047448;4177.5613560576;4178.749275043507;4179.79101044948;4180.561041090672;4186.392973018896;3651.543557055368;3653.06846754076;3655.214128962286;3661.0847288177956;3663.377225871608;5096.286519887219;5217.087009773312;5248.65883717561;5257.631965762398;5266.210068489719;4817.879553011167;4821.63837712173;4823.662343635947;4823.686460380064;4824.7828847701585;5393.5954803389905;5548.55611551075;5755.884882302373;5766.423357664242;5766.740496677659;3830.2148059647984;3868.9806550967346;3881.126746482047;3881.6894648428342;3933.960660393388;5960.195373624592;6015.879682406371;6024.939750602525;6040.607360521552;6043.244594425697;4102.159057393227;4103.815328310233;4104.4664193654635;4106.281400754856;4109.589041095866;4014.6788256939376;4165.250254954077;4166.416701661769;4172.395002724648;4174.415581818487;4757.14371413142;4758;4758.905451746048;4765.166095933268;4776.426828780569;5690.857728556819;5709.600327977002;5719.227904232958;5723.284589426322;5723.59934804568;1447.9420823167166;1484.1095342794454;1484.9628759280888;1485.4875068101487;1486.405437824857;1001.2290536287164;1001.6544292219173;1001.9398836069859;1004.7689031522791;1027.3835698580792;5026.52248036436;5032.370953630796;5039.748012599429;5042.520960508746;5043.697378157322;5947.672877991666;5952.10718392236;5957.314908785545;5959.46364827159;5963.880722385528;5003.674761140514;5023.673461225008;5027.4469808321055;5031.77357018935;5036.219385995177;3137.450946084426;3188.6970737779875;3215.951760723591;3219.227385427527;3222.2910959588853;5611.298587676541;5613.775448982076;5627.690477023803;5631.155326701028;5631.380548139701;6098.664573448415;6118.816435506942;6124.5100391968535;6126.571140020156;6127.387261273837;5482.862928426821;5609.523190528851;5623.803166889139;5629;5632.04255276604;5716.8570785729025;5877.35349111606;5934.436228558453;5941.702914854326;5942.465178133989;5742.28221472316;5830.679312637845;5856.94143058581;5870.677112758668;5872.471477567039;5647.915281270866;5649.12438572022;5652;5653.406392328746;5671.319441667027;4100.610442008005;4131.5455299917585;4136.31750761121;4139.503259608746;4141.130362623762;5780.335261444988;5963.373845746134;5988.5508586855285;6013.548983826318;6018.879622407615;5763.596548241583;5773.076307790733;5775.797847075501;5779.2198053263955;5780.421957804186;5765;5773.364929857797;5775.0471172257785;5777.162311464898;5781.4507621775865;5478.178273259043;5621.128725047624;5647.20939068539;5651.039323315129;5652.576056795675;5795.420457954339;5798;5807.361190268983;5811.331696854747;5813.418658134153;5658.066419040812;5658.40586738403;5667.291588551431;5669.943300567106;5670.121131224667 04:44:04 INFO - 2015-11-23 04:44:04,983 DEBUG : BROWSER_OUTPUT: |5;yui.html;666.163964224898;671.9496037797165;700.5586480517275;729.6133049483775;744.8473063022082;11843.644690659283;11951.581694640689;11983.520659173622;12000;12015.098867584922;13322.13406128601;13439.462421503153;13443.529476468326;13474.461021559126;13499.932500337509;636.0332294911732;644.3813938618931;797.2824457987799;811.7118422959853;812.1350761439078;770.5530792140545;785.2108630826012;791.3669064748207;791.9049714034323;792.0178978067185;841.5161282262693;847.5846835050811;847.9236868681818;848.0374774630777;849.032103402119;658.2265837640753;664.5348256220641;834.5993922917033;836.523181786382;855.4567849415604;628.6008384675719;628.6950828848005;628.8616504369031;629.2449061126621;630.180765005491;11341.659750207507;11659.417029148508;11677.88322116785;11766.470508827124;11794.174407791457;11583.305001699924;11893.286402815858;12017.158798884082;12243.571474998333;12625.24248545081;9663.516824158763;9733.124018838267;9814.263930205192;9836.409815411027;9863.40819550822;3324.966750332514;3358.865645374182;3371.8819841305435;3439;3477.565304336958;43031;43063;43264.78367608173;43787.34318985218;43856.56143438556;9805.558749856273;9966;10001.49992500372;10055.245856560787;10186.796264074677;17445.21496532659;17462.214200361013;17527.73708394375;17540.386086486913;17586.296548138187;6481.967590162019;6582.24304205013;6647.434968027772;6787.830304242433;6836.179658440919;3620.601733809279;3640.7997560133917;3661.7253705972157;3682.355587772129;3698.14942563212;2858.2711408591094;2930.077025736886;2931.5016447204025;2935.324875278698;2935.691752365971;514.1362510981512;515.6184423526563;526;531.3889027618193;531.4340227657532;498.7705306419693;527.8284557518822;594.7323704333068;606.9908951365733;666.5101150654363;8114.188581141839;8177.509349439053;8263.876041859377;8273.669053237803;8380.664773409117;407.7696101702588;501.90212908482494;604.6100265328838;640.3724350136891;642.2966851297822;3613.2050948791225;3858.9421158682644;3912.1002169501176;4035.5762644922447;4207.453031105937;49856.750716246184;50287.74856125769;51294.230586541235;51569.48430515722;51629.741851290506;41380.1723965519;41511.58488415137;41667.583324166975;42205.155896882505;44540;40792.18415631671;41641.58358416438;43548.3467747984;43904;43918.12163756771;8047.195280471906;8256.215659512336;8627.827443451222;8815.250703690259;8874.06822283651;31764.205894852814;32448.35103297968;32874.50688239726;33210.33579328448;34085.65914340825;36946.8152659235;37301.067473313386;39336.803315983234;40425.39361909633;42682.78658606687;10482.52828622729;10523.263371563917;10614.097801686634;10842.457877106272;11010.559577616805;11540.653780386601;11613.825792612948;11715.414229288672;11802.76394472123;12340.382980850742;9879.753006174904;10130.6454274103;10153.796924061626;10853.34879907208;11214.046806021579;10911.836322455329;11047.226694131334;11090.611828585961;11439.199256052329;11559.826602601135;10950;11060.834087488533;11250.549978000789;11327.716807079889;11521.827172592586;9534.332596718163;9579.90420095818;9749.512524373611;9948.850767238642;10043.648472303434;9299.30255230874;9426.905730942877;9593.904060959301;9702.417854928726;9717.319787615083 04:44:04 INFO - 2015-11-23 04:44:04,983 DEBUG : BROWSER_OUTPUT: __end_tp_report 04:44:04 INFO - 2015-11-23 04:44:04,983 DEBUG : BROWSER_OUTPUT: __start_cc_report 04:44:04 INFO - 2015-11-23 04:44:04,983 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,997 04:44:04 INFO - 2015-11-23 04:44:04,983 DEBUG : BROWSER_OUTPUT: __end_cc_report 04:44:04 INFO - 2015-11-23 04:44:04,983 DEBUG : BROWSER_OUTPUT: __startTimestamp1448282644976__endTimestamp 04:44:04 INFO - 2015-11-23 04:44:04,983 DEBUG : BROWSER_OUTPUT: 04:44:04 INFO - 2015-11-23 04:44:04,984 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 04:44:04 INFO - 2015-11-23 04:44:04,984 DEBUG : BROWSER_OUTPUT: Number of tests: 6 04:44:04 INFO - 2015-11-23 04:44:04,984 DEBUG : BROWSER_OUTPUT: 04:44:04 INFO - 2015-11-23 04:44:04,984 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4681.59 Median:4773.52 stddev:484.46 (10.1%) stddev-sans-first:459.09 04:44:04 INFO - 2015-11-23 04:44:04,984 DEBUG : BROWSER_OUTPUT: Values: 2653.7 2733.0 2742.0 2753.7 2762.0 4512.2 4649.1 4702.4 4757.3 4762.4 4633.8 4665.7 4683.5 4685.9 4689.5 4280.5 4314.2 4365.0 4506.6 4534.0 4207.2 4422.2 4455.1 4540.3 4543.1 4217.6 4281.5 4298.9 4328.5 4347.9 4415.8 4416.1 4423.0 4427.4 4447.0 4394.6 4403.6 4403.9 4412.1 4425.2 4488.6 4602.5 4604.1 4612.1 4722.5 5035.2 5042.3 5044.7 5045.9 5050.3 5068.6 5071.4 5081.2 5084.5 5086.3 4619.7 4663.5 4676.0 4681.0 4711.1 5187.7 5238.4 5244.8 5247.8 5269.4 4766.9 4872.4 4872.6 5044.3 5086.8 5038.1 5110.7 5144.7 5151.3 5202.8 4987.9 4994.9 4996.0 4997.9 5032.5 4804.4 4919.9 4923.7 4947.2 4995.9 4174.3 4254.5 4258.3 4280.6 4297.6 3717.4 3723.6 3728.3 3754.9 3760.3 4232.0 4328.1 4330.4 4399.6 4414.4 5077.5 5079.5 5129.9 5200.7 5201.7 4400.5 4416.8 4424.1 4433.7 4457.3 4333.7 4549.3 4567.2 4572.7 4605.8 4740.6 4740.9 4746.5 4758.1 4865.9 5160.2 5163.0 5164.6 5167.9 5169.9 4872.6 4876.7 4879.6 4880.5 4931.4 4773.5 4832.3 4892.0 4899.0 5090.2 5106.2 5111.9 5144.9 5200.9 5202.1 4924.1 4926.3 4932.6 4932.9 4935.1 4721.1 4847.3 4931.8 4939.5 4979.4 4766.9 4804.5 4822.8 4886.5 4912.3 4979.1 4998.2 4999.9 5012.6 5038.4 4875.3 4876.4 4878.9 4879.5 4917.4 04:44:04 INFO - 2015-11-23 04:44:04,984 DEBUG : BROWSER_OUTPUT: 04:44:04 INFO - 2015-11-23 04:44:04,984 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:43301.07 Median:33107.00 stddev:74473.01 (224.9%) stddev-sans-first:74612.76 04:44:04 INFO - 2015-11-23 04:44:04,984 DEBUG : BROWSER_OUTPUT: Values: 554.7 562.1 575.4 585.7 585.8 27697.9 34113.5 34245.5 34331.0 34367.5 39863.0 40032.6 40230.4 40403.6 40440.4 6758.2 7134.5 7516.3 7630.4 7657.9 10069.6 10310.4 10320.5 10321.3 10344.9 9874.7 9875.2 9934.2 9969.5 9969.8 7160.1 7311.2 9655.0 10152.7 10404.4 9846.5 9988.4 9991.5 9992.2 9996.5 37599.6 38089.0 38105.2 38107.8 38125.4 2946.7 2982.8 3005.1 3414.9 3634.9 28677.1 28734.4 28817.3 29126.9 29327.2 3045.9 3066.2 3114.8 3211.6 3213.2 227051.0 227605.0 227821.0 228373.0 294511.0 43294.4 52067.0 52410.5 52767.7 52958.0 53414.5 53591.5 53787.0 53825.0 53888.0 11846.0 11881.3 11955.5 11959.5 12013.7 9560.6 9562.5 9578.7 9648.3 9668.7 17713.6 17854.6 17891.2 17893.6 17944.5 7488.0 7691.5 7702.4 7703.1 7817.3 780.9 832.5 907.0 908.2 993.1 26122.0 26485.7 26510.4 26807.7 26869.7 936.0 943.9 949.9 957.2 995.3 13763.2 13777.7 13914.7 13915.0 14017.6 276299.0 278721.0 280422.0 281402.0 281561.0 45963.5 46160.1 46165.5 46171.8 46276.3 1064.7 1109.1 1175.2 1180.1 1271.0 25547.9 26217.3 26770.6 27093.2 27110.0 35632.3 35787.8 36171.8 36445.3 36955.3 319137.0 326056.0 326219.0 326352.0 327269.0 26803.0 27326.6 27344.2 27369.5 27381.9 36920.0 37421.6 37736.8 37781.0 38191.6 30745.8 32136.8 32681.2 32704.9 33133.3 32417.0 32734.3 32956.5 33080.7 33191.3 31963.8 33051.2 33202.7 33295.0 33323.3 27860.2 29653.6 29830.6 29849.4 30083.0 23009.6 23407.5 23445.3 23550.6 23654.9 04:44:04 INFO - 2015-11-23 04:44:04,984 DEBUG : BROWSER_OUTPUT: 04:44:04 INFO - 2015-11-23 04:44:04,985 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:27012.08 Median:1909.11 stddev:85191.87 (4462.4%) stddev-sans-first:85407.32 04:44:04 INFO - 2015-11-23 04:44:04,986 DEBUG : BROWSER_OUTPUT: Values: 343.6 344.1 345.2 345.6 348.1 12019.4 12321.9 14896.6 15192.5 16792.8 12357.6 14763.3 14972.0 15034.7 15046.3 3060.2 3513.0 3523.8 3543.6 5025.5 3392.7 3470.1 5080.9 5150.9 5152.3 5201.0 5345.4 5364.7 5366.2 5376.6 5216.8 5328.1 5329.1 5332.8 5359.4 5129.7 5153.5 5157.3 5160.5 5161.4 11741.1 13005.0 17337.8 19085.0 19116.3 1809.2 1837.5 1921.4 1935.4 1966.1 9053.8 9391.9 10547.1 12701.6 12977.5 1796.1 1800.5 1918.7 1957.7 2008.9 53590.0 55200.0 56042.7 56530.0 57069.7 9862.2 9880.7 9889.6 9901.2 9914.0 12452.2 12457.6 12473.1 12483.0 12489.0 6710.1 6717.3 6721.4 6755.5 6770.9 6289.6 6401.3 6401.7 6419.4 6454.4 4145.3 4214.5 4214.5 4238.8 4262.2 1611.1 1672.9 1688.5 1718.3 1723.4 816.3 852.1 906.5 912.5 1004.3 15512.6 15907.8 16093.2 16174.4 16319.3 763.5 793.3 840.3 854.3 873.8 7636.0 8613.0 8676.6 8794.3 8808.6 508449.0 511212.0 528387.0 528819.0 530178.0 70610.3 70875.6 72571.6 73888.6 76137.6 1030.6 1049.6 1050.7 1056.7 1058.1 13738.7 14201.6 14222.9 14397.6 14401.4 31649.0 32334.0 32735.0 33680.8 34268.8 41738.4 41888.6 42149.8 43221.8 47503.0 8563.7 8787.0 8933.2 8940.4 8943.6 10487.5 10497.2 10502.6 10515.9 10644.4 12263.9 13480.1 13782.0 13864.9 13965.2 11982.9 11987.2 12448.2 12520.7 12785.6 12710.1 13299.0 13775.1 14109.3 14176.9 7068.2 8137.4 8755.5 8767.1 8936.5 11733.6 11948.3 12240.7 13287.2 13380.8 04:44:04 INFO - 2015-11-23 04:44:04,986 DEBUG : BROWSER_OUTPUT: 04:44:04 INFO - 2015-11-23 04:44:04,986 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4944.99 Median:6132.09 stddev:2516.15 (41.0%) stddev-sans-first:2509.05 04:44:04 INFO - 2015-11-23 04:44:04,986 DEBUG : BROWSER_OUTPUT: Values: 1393.0 1424.7 1458.0 1550.6 1701.9 5939.5 6650.7 6778.0 6798.8 6805.8 6877.3 6913.6 6969.9 6981.0 6991.2 2074.8 2102.6 2103.1 2103.8 2104.6 1957.4 2091.6 2100.3 2104.2 2111.4 2058.4 2087.8 2097.5 2098.4 2102.1 2060.5 2077.8 2079.6 2079.7 2089.6 2024.9 2039.6 2049.8 2051.5 2054.5 5850.5 6042.7 6851.1 6891.5 6892.1 4125.6 4261.8 4264.4 4264.7 4272.7 2814.7 2822.7 2851.7 2852.2 2900.3 876.4 876.8 877.9 889.1 907.3 9418.4 9539.1 9551.0 9552.7 9569.1 3874.0 3887.8 3925.0 3930.6 4007.3 8237.7 8243.3 8250.1 8251.5 8267.4 4299.4 4303.2 4313.0 4315.1 4316.7 3922.7 3922.8 3928.3 3928.7 3934.3 3296.9 3300.6 3319.5 3331.9 3345.2 1093.8 1096.5 1098.6 1104.3 1112.5 896.1 980.6 1146.0 1159.9 1168.2 6648.2 6769.7 6787.5 6787.6 6788.0 1039.5 1052.5 1058.6 1077.3 1079.2 4852.2 5241.5 5300.2 5304.3 5313.6 7390.0 8436.7 8495.0 8495.9 8513.2 8203.9 8262.4 8324.4 8327.9 8333.3 6406.8 6599.7 6603.9 6643.8 6665.2 6643.6 6645.0 6707.8 6710.4 6714.4 7514.2 7532.6 7605.7 7656.3 7666.8 7464.3 7584.8 7770.9 7771.0 7774.0 6219.7 6221.1 6242.4 6260.4 6271.1 6876.7 6915.7 6917.1 6929.8 6966.8 6440.7 6506.5 6571.0 6625.9 6650.7 6317.7 6430.0 6432.3 6546.3 6568.5 6377.5 6428.6 6437.0 6438.1 6446.6 5811.1 5923.6 5924.8 6018.8 6044.5 5988.1 6024.5 6024.8 6031.5 6037.8 04:44:04 INFO - 2015-11-23 04:44:04,986 DEBUG : BROWSER_OUTPUT: 04:44:04 INFO - 2015-11-23 04:44:04,986 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4747.45 Median:5283.39 stddev:1400.08 (26.5%) stddev-sans-first:1363.87 04:44:04 INFO - 2015-11-23 04:44:04,986 DEBUG : BROWSER_OUTPUT: Values: 312.7 316.0 317.1 317.5 318.7 5300.6 5313.3 5463.6 5545.8 5572.4 5233.8 5373.7 5383.8 5391.8 5392.6 4033.2 4126.7 4209.8 4216.8 4219.9 4121.1 4214.7 4216.6 4221.7 4224.7 4165.1 4171.1 4174.6 4181.1 4189.8 4177.6 4178.7 4179.8 4180.6 4186.4 3651.5 3653.1 3655.2 3661.1 3663.4 5096.3 5217.1 5248.7 5257.6 5266.2 4817.9 4821.6 4823.7 4823.7 4824.8 5393.6 5548.6 5755.9 5766.4 5766.7 3830.2 3869.0 3881.1 3881.7 3934.0 5960.2 6015.9 6024.9 6040.6 6043.2 4102.2 4103.8 4104.5 4106.3 4109.6 4014.7 4165.3 4166.4 4172.4 4174.4 4757.1 4758.0 4758.9 4765.2 4776.4 5690.9 5709.6 5719.2 5723.3 5723.6 1447.9 1484.1 1485.0 1485.5 1486.4 1001.2 1001.7 1001.9 1004.8 1027.4 5026.5 5032.4 5039.7 5042.5 5043.7 5947.7 5952.1 5957.3 5959.5 5963.9 5003.7 5023.7 5027.4 5031.8 5036.2 3137.5 3188.7 3216.0 3219.2 3222.3 5611.3 5613.8 5627.7 5631.2 5631.4 6098.7 6118.8 6124.5 6126.6 6127.4 5482.9 5609.5 5623.8 5629.0 5632.0 5716.9 5877.4 5934.4 5941.7 5942.5 5742.3 5830.7 5856.9 5870.7 5872.5 5647.9 5649.1 5652.0 5653.4 5671.3 4100.6 4131.5 4136.3 4139.5 4141.1 5780.3 5963.4 5988.6 6013.5 6018.9 5763.6 5773.1 5775.8 5779.2 5780.4 5765.0 5773.4 5775.0 5777.2 5781.5 5478.2 5621.1 5647.2 5651.0 5652.6 5795.4 5798.0 5807.4 5811.3 5813.4 5658.1 5658.4 5667.3 5669.9 5670.1 04:44:04 INFO - 2015-11-23 04:44:04,987 DEBUG : BROWSER_OUTPUT: 04:44:04 INFO - 2015-11-23 04:44:04,987 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12670.59 Median:43047.00 stddev:14079.56 (32.7%) stddev-sans-first:14090.20 04:44:04 INFO - 2015-11-23 04:44:04,988 DEBUG : BROWSER_OUTPUT: Values: 666.2 671.9 700.6 729.6 744.8 11843.6 11951.6 11983.5 12000.0 12015.1 13322.1 13439.5 13443.5 13474.5 13499.9 636.0 644.4 797.3 811.7 812.1 770.6 785.2 791.4 791.9 792.0 841.5 847.6 847.9 848.0 849.0 658.2 664.5 834.6 836.5 855.5 628.6 628.7 628.9 629.2 630.2 11341.7 11659.4 11677.9 11766.5 11794.2 11583.3 11893.3 12017.2 12243.6 12625.2 9663.5 9733.1 9814.3 9836.4 9863.4 3325.0 3358.9 3371.9 3439.0 3477.6 43031.0 43063.0 43264.8 43787.3 43856.6 9805.6 9966.0 10001.5 10055.2 10186.8 17445.2 17462.2 17527.7 17540.4 17586.3 6482.0 6582.2 6647.4 6787.8 6836.2 3620.6 3640.8 3661.7 3682.4 3698.1 2858.3 2930.1 2931.5 2935.3 2935.7 514.1 515.6 526.0 531.4 531.4 498.8 527.8 594.7 607.0 666.5 8114.2 8177.5 8263.9 8273.7 8380.7 407.8 501.9 604.6 640.4 642.3 3613.2 3858.9 3912.1 4035.6 4207.5 49856.8 50287.7 51294.2 51569.5 51629.7 41380.2 41511.6 41667.6 42205.2 44540.0 40792.2 41641.6 43548.3 43904.0 43918.1 8047.2 8256.2 8627.8 8815.3 8874.1 31764.2 32448.4 32874.5 33210.3 34085.7 36946.8 37301.1 39336.8 40425.4 42682.8 10482.5 10523.3 10614.1 10842.5 11010.6 11540.7 11613.8 11715.4 11802.8 12340.4 9879.8 10130.6 10153.8 10853.3 11214.0 10911.8 11047.2 11090.6 11439.2 11559.8 10950.0 11060.8 11250.5 11327.7 11521.8 9534.3 9579.9 9749.5 9948.9 10043.6 9299.3 9426.9 9593.9 9702.4 9717.3 04:44:04 INFO - 2015-11-23 04:44:04,988 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 04:44:04 INFO - 2015-11-23 04:44:04,988 DEBUG : BROWSER_OUTPUT: 04:44:05 INFO - 2015-11-23 04:44:05,700 INFO : Browser exited with error code: 0 04:44:05 INFO - 2015-11-23 04:44:05,721 INFO : Completed test dromaeo_css (00:18:38) 04:44:05 INFO - 2015-11-23 04:44:05,721 INFO : Starting test kraken 04:44:05 INFO - 2015-11-23 04:44:05,721 DEBUG : operating with platform_type : linux_ 04:44:05 INFO - 2015-11-23 04:44:05,721 INFO : Initialising browser for kraken test... 04:44:05 INFO - 2015-11-23 04:44:05,727 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpqbERBd/profile http://localhost:36145/getInfo.html 04:44:09 INFO - 2015-11-23 04:44:09,735 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 04:44:09 INFO - 2015-11-23 04:44:09,736 DEBUG : BROWSER_OUTPUT: colorDepth:24 04:44:09 INFO - 2015-11-23 04:44:09,736 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 04:44:09 INFO - 2015-11-23 04:44:09,736 DEBUG : BROWSER_OUTPUT: __metrics 04:44:09 INFO - 2015-11-23 04:44:09,857 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:44:11 INFO - 2015-11-23 04:44:11,096 INFO : Browser initialized. 04:44:11 INFO - 2015-11-23 04:44:11,097 INFO : Running cycle 1/1 for kraken test... 04:44:11 INFO - 2015-11-23 04:44:11,097 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpqbERBd/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 04:44:23 INFO - 2015-11-23 04:44:23,042 DEBUG : BROWSER_OUTPUT: RSS: Main: 141991936 04:44:23 INFO - 2015-11-23 04:44:23,042 DEBUG : BROWSER_OUTPUT: 04:44:25 INFO - 2015-11-23 04:44:25,659 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:36145/tests/kraken/driver.html?testName=audio-beat-detection) 04:44:26 INFO - 2015-11-23 04:44:26,240 DEBUG : BROWSER_OUTPUT: RSS: Main: 174510080 04:44:26 INFO - 2015-11-23 04:44:26,241 DEBUG : BROWSER_OUTPUT: 04:44:28 INFO - 2015-11-23 04:44:28,986 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:36145/tests/kraken/driver.html?testName=audio-dft) 04:44:29 INFO - 2015-11-23 04:44:29,561 DEBUG : BROWSER_OUTPUT: RSS: Main: 166395904 04:44:29 INFO - 2015-11-23 04:44:29,561 DEBUG : BROWSER_OUTPUT: 04:44:32 INFO - 2015-11-23 04:44:32,547 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:36145/tests/kraken/driver.html?testName=audio-fft) 04:44:33 INFO - 2015-11-23 04:44:33,113 DEBUG : BROWSER_OUTPUT: RSS: Main: 151412736 04:44:33 INFO - 2015-11-23 04:44:33,113 DEBUG : BROWSER_OUTPUT: 04:44:35 INFO - 2015-11-23 04:44:35,150 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:36145/tests/kraken/driver.html?testName=audio-oscillator) 04:44:35 INFO - 2015-11-23 04:44:35,731 DEBUG : BROWSER_OUTPUT: RSS: Main: 154234880 04:44:35 INFO - 2015-11-23 04:44:35,732 DEBUG : BROWSER_OUTPUT: 04:44:37 INFO - 2015-11-23 04:44:37,957 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:36145/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:44:38 INFO - 2015-11-23 04:44:38,523 DEBUG : BROWSER_OUTPUT: RSS: Main: 156848128 04:44:38 INFO - 2015-11-23 04:44:38,523 DEBUG : BROWSER_OUTPUT: 04:44:41 INFO - 2015-11-23 04:44:41,527 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:36145/tests/kraken/driver.html?testName=imaging-darkroom) 04:44:42 INFO - 2015-11-23 04:44:42,100 DEBUG : BROWSER_OUTPUT: RSS: Main: 155545600 04:44:42 INFO - 2015-11-23 04:44:42,100 DEBUG : BROWSER_OUTPUT: 04:44:45 INFO - 2015-11-23 04:44:45,510 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:36145/tests/kraken/driver.html?testName=imaging-desaturate) 04:44:46 INFO - 2015-11-23 04:44:46,091 DEBUG : BROWSER_OUTPUT: RSS: Main: 157798400 04:44:46 INFO - 2015-11-23 04:44:46,092 DEBUG : BROWSER_OUTPUT: 04:44:48 INFO - 2015-11-23 04:44:48,916 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:36145/tests/kraken/driver.html?testName=json-parse-financial) 04:44:49 INFO - 2015-11-23 04:44:49,501 DEBUG : BROWSER_OUTPUT: RSS: Main: 158076928 04:44:49 INFO - 2015-11-23 04:44:49,501 DEBUG : BROWSER_OUTPUT: 04:44:51 INFO - 2015-11-23 04:44:51,300 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:36145/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:44:51 INFO - 2015-11-23 04:44:51,867 DEBUG : BROWSER_OUTPUT: RSS: Main: 166965248 04:44:51 INFO - 2015-11-23 04:44:51,867 DEBUG : BROWSER_OUTPUT: 04:44:53 INFO - 2015-11-23 04:44:53,790 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:36145/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:44:54 INFO - 2015-11-23 04:44:54,392 DEBUG : BROWSER_OUTPUT: RSS: Main: 165527552 04:44:54 INFO - 2015-11-23 04:44:54,392 DEBUG : BROWSER_OUTPUT: 04:44:56 INFO - 2015-11-23 04:44:56,490 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:36145/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:44:57 INFO - 2015-11-23 04:44:57,072 DEBUG : BROWSER_OUTPUT: RSS: Main: 174551040 04:44:57 INFO - 2015-11-23 04:44:57,072 DEBUG : BROWSER_OUTPUT: 04:44:59 INFO - 2015-11-23 04:44:59,567 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:36145/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:45:00 INFO - 2015-11-23 04:45:00,148 DEBUG : BROWSER_OUTPUT: RSS: Main: 181465088 04:45:00 INFO - 2015-11-23 04:45:00,148 DEBUG : BROWSER_OUTPUT: 04:45:02 INFO - 2015-11-23 04:45:02,702 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:36145/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:45:03 INFO - 2015-11-23 04:45:03,288 DEBUG : BROWSER_OUTPUT: RSS: Main: 178429952 04:45:03 INFO - 2015-11-23 04:45:03,288 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,040 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:36145/tests/kraken/driver.html?testName=ai-astar) 04:45:05 INFO - 2015-11-23 04:45:05,298 DEBUG : BROWSER_OUTPUT: RSS: Main: 237043712 04:45:05 INFO - 2015-11-23 04:45:05,298 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,298 DEBUG : BROWSER_OUTPUT: __start_tp_report 04:45:05 INFO - 2015-11-23 04:45:05,298 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 04:45:05 INFO - 2015-11-23 04:45:05,298 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |0;ai-astar;109;114;106;113;113;112;100;114;105;111 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;155;142;158;165;129;151;156;131;185;135 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |2;audio-dft;163;162;162;163;161;160;161;162;162;161 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |3;audio-fft;73;73;86;93;72;72;75;103;91;73 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;91;92;128;92;93;92;127;91;92;133 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;109;110;109;108;110;109;110;110;110 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;148;148;146;147;147;147;146;147;147;147 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;96;96;95;95;96;95;95;95;95 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;70;72;69;70;70;69;71;71;72;69 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;69;70;69;69;70;70;69;70;69 04:45:05 INFO - 2015-11-23 04:45:05,299 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;83;82;82;83;81;82;82;83;84;82 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;120;121;128;116;126;119;127;118;129;119 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;145;142;161;140;150;136;137;149;139;140 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;68;67;70;69;69;69;68;68;68;68 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: __end_tp_report 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: __start_cc_report 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,1005 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: __end_cc_report 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: __startTimestamp1448282705293__endTimestamp 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: Number of tests: 14 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,300 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:109.70 Median:112.50 stddev:4.67 (4.1%) stddev-sans-first:4.94 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: Values: 109.0 114.0 106.0 113.0 113.0 112.0 100.0 114.0 105.0 111.0 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:150.70 Median:155.50 stddev:17.20 (11.1%) stddev-sans-first:18.17 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: Values: 155.0 142.0 158.0 165.0 129.0 151.0 156.0 131.0 185.0 135.0 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.70 Median:162.00 stddev:0.95 (0.6%) stddev-sans-first:0.88 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: Values: 163.0 162.0 162.0 163.0 161.0 160.0 161.0 162.0 162.0 161.0 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:81.10 Median:74.00 stddev:11.27 (15.2%) stddev-sans-first:11.57 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: Values: 73.0 73.0 86.0 93.0 72.0 72.0 75.0 103.0 91.0 73.0 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,301 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:103.10 Median:92.00 stddev:18.17 (19.8%) stddev-sans-first:18.74 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: Values: 91.0 92.0 128.0 92.0 93.0 92.0 127.0 91.0 92.0 133.0 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.50 Median:110.00 stddev:0.71 (0.6%) stddev-sans-first:0.73 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: Values: 110.0 109.0 110.0 109.0 108.0 110.0 109.0 110.0 110.0 110.0 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:147.00 Median:147.00 stddev:0.67 (0.5%) stddev-sans-first:0.60 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: Values: 148.0 148.0 146.0 147.0 147.0 147.0 146.0 147.0 147.0 147.0 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.40 Median:95.50 stddev:0.52 (0.5%) stddev-sans-first:0.50 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: Values: 96.0 96.0 96.0 95.0 95.0 96.0 95.0 95.0 95.0 95.0 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,302 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:70.30 Median:70.50 stddev:1.16 (1.6%) stddev-sans-first:1.22 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: Values: 70.0 72.0 69.0 70.0 70.0 69.0 71.0 71.0 72.0 69.0 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:69.30 Median:69.50 stddev:0.67 (1.0%) stddev-sans-first:0.53 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: Values: 68.0 69.0 70.0 69.0 69.0 70.0 70.0 69.0 70.0 69.0 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:82.40 Median:82.50 stddev:0.84 (1.0%) stddev-sans-first:0.87 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: Values: 83.0 82.0 82.0 83.0 81.0 82.0 82.0 83.0 84.0 82.0 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:122.30 Median:123.50 stddev:4.72 (3.8%) stddev-sans-first:4.93 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: Values: 120.0 121.0 128.0 116.0 126.0 119.0 127.0 118.0 129.0 119.0 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:143.90 Median:143.50 stddev:7.64 (5.3%) stddev-sans-first:8.09 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: Values: 145.0 142.0 161.0 140.0 150.0 136.0 137.0 149.0 139.0 140.0 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: 04:45:05 INFO - 2015-11-23 04:45:05,303 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.40 Median:68.50 stddev:0.84 (1.2%) stddev-sans-first:0.88 04:45:05 INFO - 2015-11-23 04:45:05,304 DEBUG : BROWSER_OUTPUT: Values: 68.0 67.0 70.0 69.0 69.0 69.0 68.0 68.0 68.0 68.0 04:45:05 INFO - 2015-11-23 04:45:05,304 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 04:45:05 INFO - 2015-11-23 04:45:05,304 DEBUG : BROWSER_OUTPUT: 04:45:06 INFO - 2015-11-23 04:45:06,224 INFO : Browser exited with error code: 0 04:45:06 INFO - 2015-11-23 04:45:06,275 INFO : Completed test kraken (00:01:00) 04:45:06 INFO - 2015-11-23 04:45:06,275 INFO : Starting test v8_7 04:45:06 INFO - 2015-11-23 04:45:06,275 DEBUG : operating with platform_type : linux_ 04:45:06 INFO - 2015-11-23 04:45:06,276 INFO : Initialising browser for v8_7 test... 04:45:06 INFO - 2015-11-23 04:45:06,282 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsfPG4T/profile http://localhost:36145/getInfo.html 04:45:10 INFO - 2015-11-23 04:45:10,402 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 04:45:10 INFO - 2015-11-23 04:45:10,404 DEBUG : BROWSER_OUTPUT: colorDepth:24 04:45:10 INFO - 2015-11-23 04:45:10,404 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 04:45:10 INFO - 2015-11-23 04:45:10,404 DEBUG : BROWSER_OUTPUT: __metrics 04:45:10 INFO - 2015-11-23 04:45:10,545 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 04:45:11 INFO - 2015-11-23 04:45:11,850 INFO : Browser initialized. 04:45:11 INFO - 2015-11-23 04:45:11,851 INFO : Running cycle 1/1 for v8_7 test... 04:45:11 INFO - 2015-11-23 04:45:11,851 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpsfPG4T/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 04:45:23 INFO - 2015-11-23 04:45:23,846 DEBUG : BROWSER_OUTPUT: RSS: Main: 142221312 04:45:23 INFO - 2015-11-23 04:45:23,847 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,311 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:36145/tests/v8_7/run.html (next: http://localhost:36145/tests/v8_7/run.html) 04:45:45 INFO - 2015-11-23 04:45:45,561 DEBUG : BROWSER_OUTPUT: RSS: Main: 456265728 04:45:45 INFO - 2015-11-23 04:45:45,561 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,561 DEBUG : BROWSER_OUTPUT: __start_tp_report 04:45:45 INFO - 2015-11-23 04:45:45,561 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 04:45:45 INFO - 2015-11-23 04:45:45,562 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 04:45:45 INFO - 2015-11-23 04:45:45,562 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 04:45:45 INFO - 2015-11-23 04:45:45,562 DEBUG : BROWSER_OUTPUT: |0;Richards;163.26530612244898 04:45:45 INFO - 2015-11-23 04:45:45,562 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;192.789666473877 04:45:45 INFO - 2015-11-23 04:45:45,562 DEBUG : BROWSER_OUTPUT: |2;Encrypt;279.87685418415896 04:45:45 INFO - 2015-11-23 04:45:45,562 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5060.606060606061 04:45:45 INFO - 2015-11-23 04:45:45,562 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1994.0239043824702 04:45:45 INFO - 2015-11-23 04:45:45,563 DEBUG : BROWSER_OUTPUT: |5;Earley;798.0845969672786 04:45:45 INFO - 2015-11-23 04:45:45,563 DEBUG : BROWSER_OUTPUT: |6;Boyer;12493.827160493827 04:45:45 INFO - 2015-11-23 04:45:45,563 DEBUG : BROWSER_OUTPUT: |7;RegExp;26736.842105263157 04:45:45 INFO - 2015-11-23 04:45:45,563 DEBUG : BROWSER_OUTPUT: |8;Splay;625 04:45:45 INFO - 2015-11-23 04:45:45,564 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4830.917874396136 04:45:45 INFO - 2015-11-23 04:45:45,564 DEBUG : BROWSER_OUTPUT: __end_tp_report 04:45:45 INFO - 2015-11-23 04:45:45,564 DEBUG : BROWSER_OUTPUT: __startTimestamp1448282745559__endTimestamp 04:45:45 INFO - 2015-11-23 04:45:45,564 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,564 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 04:45:45 INFO - 2015-11-23 04:45:45,565 DEBUG : BROWSER_OUTPUT: Number of tests: 10 04:45:45 INFO - 2015-11-23 04:45:45,565 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,565 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:163.27 Median:163.27 stddev:0.00 (0.0%) 04:45:45 INFO - 2015-11-23 04:45:45,565 DEBUG : BROWSER_OUTPUT: Values: 163.3 04:45:45 INFO - 2015-11-23 04:45:45,565 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,565 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:192.79 Median:192.79 stddev:0.00 (0.0%) 04:45:45 INFO - 2015-11-23 04:45:45,566 DEBUG : BROWSER_OUTPUT: Values: 192.8 04:45:45 INFO - 2015-11-23 04:45:45,566 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,566 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:279.88 Median:279.88 stddev:0.00 (0.0%) 04:45:45 INFO - 2015-11-23 04:45:45,566 DEBUG : BROWSER_OUTPUT: Values: 279.9 04:45:45 INFO - 2015-11-23 04:45:45,566 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,566 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5060.61 Median:5060.61 stddev:0.00 (0.0%) 04:45:45 INFO - 2015-11-23 04:45:45,567 DEBUG : BROWSER_OUTPUT: Values: 5060.6 04:45:45 INFO - 2015-11-23 04:45:45,567 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,567 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1994.02 Median:1994.02 stddev:0.00 (0.0%) 04:45:45 INFO - 2015-11-23 04:45:45,567 DEBUG : BROWSER_OUTPUT: Values: 1994.0 04:45:45 INFO - 2015-11-23 04:45:45,567 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,567 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:798.08 Median:798.08 stddev:0.00 (0.0%) 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: Values: 798.1 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12493.83 Median:12493.83 stddev:0.00 (0.0%) 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: Values: 12493.8 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:26736.84 Median:26736.84 stddev:0.00 (0.0%) 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: Values: 26736.8 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:625.00 Median:625.00 stddev:0.00 (0.0%) 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: Values: 625.0 04:45:45 INFO - 2015-11-23 04:45:45,568 DEBUG : BROWSER_OUTPUT: 04:45:45 INFO - 2015-11-23 04:45:45,569 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4830.92 Median:4830.92 stddev:0.00 (0.0%) 04:45:45 INFO - 2015-11-23 04:45:45,569 DEBUG : BROWSER_OUTPUT: Values: 4830.9 04:45:45 INFO - 2015-11-23 04:45:45,569 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 04:45:45 INFO - 2015-11-23 04:45:45,569 DEBUG : BROWSER_OUTPUT: 04:45:46 INFO - 2015-11-23 04:45:46,468 INFO : Browser exited with error code: 0 04:45:46 INFO - 2015-11-23 04:45:46,482 INFO : Completed test v8_7 (00:00:40) 04:45:46 INFO - 2015-11-23 04:45:46,533 INFO : Completed test suite (00:20:19) 04:45:46 INFO - 2015-11-23 04:45:46,534 DEBUG : Working with test: dromaeo_css 04:45:46 INFO - 2015-11-23 04:45:46,534 DEBUG : Generating results file: dromaeo_css 04:45:46 INFO - 2015-11-23 04:45:46,535 DEBUG : Working with test: kraken 04:45:46 INFO - 2015-11-23 04:45:46,535 DEBUG : Generating results file: kraken 04:45:46 INFO - 2015-11-23 04:45:46,535 INFO : javascript benchmark 04:45:46 INFO - 2015-11-23 04:45:46,535 DEBUG : Working with test: v8_7 04:45:46 INFO - 2015-11-23 04:45:46,536 DEBUG : Generating results file: v8_7 04:45:46 INFO - 2015-11-23 04:45:46,536 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:45:46 INFO - 2015-11-23 04:45:46,685 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,94,35]] 04:45:46 INFO - 2015-11-23 04:45:46,685 DEBUG : process_Request line: dromaeo_css 6361.27 graph.html#tests=[[72,94,35]] 04:45:46 INFO - 2015-11-23 04:45:46,685 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:45:46 INFO - 2015-11-23 04:45:46,731 DEBUG : process_Request line: kraken 1514.80 graph.html#tests=[[232,94,35]] 04:45:46 INFO - 2015-11-23 04:45:46,731 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:45:46 INFO - 2015-11-23 04:45:46,776 DEBUG : process_Request line: v8_7 19677.05 graph.html#tests=[[230,94,35]] 04:45:46 INFO - 2015-11-23 04:45:46,777 INFO : javascript benchmark 04:45:46 INFO - 2015-11-23 04:45:46,780 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2653.694825095114, 2732.9863350683245, 2742.0, 2753.7246275372463, 2761.9723802761973, 4512.187806194892, 4649.093426781779, 4702.388689470368, 4757.262624293231, 4762.428508578967, 4633.791479383427, 4665.6500762442865, 4683.50823163568, 4685.929711054337, 4689.507601701824, 4280.464941882265, 4314.1803057419065, 4365.039691267916, 4506.594406503414, 4534.047849951514, 4207.221663992172, 4422.159789639974, 4455.108978204372, 4540.250858608326, 4543.136804007245, 4217.6204141627095, 4281.464816897887, 4298.892527686801, 4328.545502722201, 4347.891302717426, 4415.779211039435, 4416.094700586372, 4423.049044455425, 4427.446569178853, 4446.955530444687, 4394.648428125743, 4403.559644035603, 4403.889902752425, 4412.117576484716, 4425.225585522553, 4488.5960263576435, 4602.470715867685, 4604.125216208943, 4612.100640375128, 4722.472901811822, 5035.244713292998, 5042.268871013719, 5044.747762611892, 5045.873853153664, 5050.3434553507805, 5068.5691716204165, 5071.39143302806, 5081.212412076134, 5084.491550844923, 5086.287919691246, 4619.699719518254, 4663.51033141522, 4675.95324046762, 4681.0, 4711.1284412383475, 5187.740612969336, 5238.371395432572, 5244.763985620656, 5247.7667748079175, 5269.394019687708, 4766.904661906742, 4872.439669437989, 4872.585830204402, 5044.319016932741, 5086.847394578169, 5038.143515602356, 5110.744462776846, 5144.6913185209005, 5151.278820965068, 5202.817901373433, 4987.875303117378, 4994.850154495371, 4995.975020124949, 4997.900041999213, 5032.496750324938, 4804.447488538793, 4919.877003074952, 4923.655344125948, 4947.208446648519, 4995.875103122451, 4174.332106862948, 4254.532001479834, 4258.339957306623, 4280.586299730743, 4297.613214810682, 3717.442383642421, 3723.5717892442176, 3728.3102626014274, 3754.887353379403, 3760.341940160461, 4232.0, 4328.091100868853, 4330.372096046056, 4399.6040356368085, 4414.359917811899, 5077.466865979093, 5079.5428411443145, 5129.948700512947, 5200.6879587224885, 5201.687898726089, 4400.471943366816, 4416.823327066945, 4424.0709451015, 4433.689641725048, 4457.286834106528, 4333.71830830995, 4549.294859296814, 4567.223571992769, 4572.657050721143, 4605.815767369335, 4740.620750340034, 4740.928886066712, 4746.501617330268, 4758.119747846659, 4865.929495510982, 5160.200168973815, 5163.0, 5164.638475306692, 5167.92248116271, 5169.870753231199, 4872.561469467765, 4876.683015603974, 4879.634027447884, 4880.487548807324, 4931.358923340086, 4773.522647735199, 4832.251001094836, 4891.9971405861, 4898.975505122452, 5090.211017292326, 5106.234064890147, 5111.923321150261, 5144.871378215575, 5200.895982080261, 5202.063628546898, 4924.089043526959, 4926.261060840902, 4932.556069953722, 4932.901341973212, 4935.062338155739, 4721.055788842314, 4847.2729090636685, 4931.753412329297, 4939.456659767351, 4979.377577802775, 4766.928496072493, 4804.495527969652, 4822.7829747660735, 4886.53577910098, 4912.263160525949, 4979.103761322996, 4998.2002879539095, 4999.925001124913, 5012.573931215888, 5038.445770965264, 4875.3174555562955, 4876.366072410564, 4878.878028049186, 4879.463259041431, 4917.360743103373], "unit": "ms", "name": "dojo.html", "value": 4651.857809338169}, {"lowerIsBetter": false, "replicates": [554.7420449490988, 562.0809975689746, 575.4418214332097, 585.721782153477, 585.8330375842883, 27697.861510692444, 34113.488297675525, 34245.45895434705, 34331.0, 34367.484487732676, 39863.0, 40032.59967400325, 40230.396544051866, 40403.59596404035, 40440.39339409904, 6758.22280437751, 7134.500584959055, 7516.323530882206, 7630.351420129296, 7657.923420765805, 10069.64756233532, 10310.381377117359, 10320.483975801217, 10321.277510574262, 10344.948275258614, 9874.703758887208, 9875.209983201326, 9934.205263578897, 9969.451680157625, 9969.800603987916, 7160.104986876667, 7311.1592166900955, 9654.951725241364, 10152.746181345525, 10404.375737455777, 9846.458444785534, 9988.400695958266, 9991.500424978722, 9992.200623950066, 9996.50017499122, 37599.62400376016, 38089.0, 38105.23789524194, 38107.8094609528, 38125.428118578246, 2946.6905974872543, 2982.7762917781038, 3005.068428787083, 3414.8551175536327, 3634.872779452733, 28677.13968580946, 28734.425311493862, 28817.34331104103, 29126.854365728246, 29327.187569697504, 3045.8629361678777, 3066.156806878104, 3114.7508199343997, 3211.550382946389, 3213.1806389370795, 227051.0, 227605.0, 227821.0, 228373.0, 294510.99999999785, 43294.35058474125, 52067.0, 52410.475895241325, 52767.73616131895, 52958.0, 53414.465855341725, 53591.464085358646, 53787.0, 53825.0, 53888.0, 11846.0, 11881.287122772661, 11955.52177912891, 11959.461824217931, 12013.699657508458, 9560.617575297048, 9562.521873906417, 9578.664746733832, 9648.276379271583, 9668.661596844217, 17713.645727085386, 17854.55363615894, 17891.1948962297, 17893.552661183316, 17944.461666150037, 7487.962560187164, 7691.50005249657, 7702.422318326148, 7703.114141873756, 7817.335526480313, 780.8867714181412, 832.5337810825957, 906.9637214511478, 908.2234689340651, 993.1210878372692, 26122.0, 26485.73514264871, 26510.44845741994, 26807.731922680912, 26869.731302686723, 936.0265324063034, 943.9363539960399, 949.9145076943108, 957.1816097236763, 995.3381001633977, 13763.243021633705, 13777.724445511034, 13914.652133696738, 13915.0, 14017.649558760908, 276299.0, 278721.0, 280422.0, 281402.0, 281561.0, 45963.54036459592, 46160.076798463844, 46165.5383446168, 46171.76914115408, 46276.305855412196, 1064.685917654294, 1109.0905457524752, 1175.1949914308555, 1180.0677464802882, 1271.0467149637773, 25547.872260638578, 26217.34456638523, 26770.598441023012, 27093.1872043839, 27110.0, 35632.28735425329, 35787.82106089453, 36171.819140904125, 36445.27109457743, 36955.26089478249, 319137.0, 326056.0, 326219.0, 326352.0, 327269.0, 26803.0, 27326.5901011481, 27344.179674609793, 27369.45261094807, 27381.86309068442, 36920.0, 37421.625783741816, 37736.81131594325, 37781.0, 38191.61808381881, 30745.846270768503, 32136.83931580327, 32681.18297042593, 32704.889550757012, 33133.33733325272, 32417.0, 32734.34531309408, 32956.50565241571, 33080.66919330776, 33191.336173275915, 31963.840180798947, 33051.17372065622, 33202.667973319956, 33295.0, 33323.333533329685, 27860.249362114042, 29653.555196671634, 29830.552541712324, 29849.403011940074, 30083.0, 23009.589402392186, 23407.53184936326, 23445.296641100795, 23550.646740298565, 23654.88172559126], "unit": "ms", "name": "ext.html", "value": 17023.448648571284}, {"lowerIsBetter": false, "replicates": [343.5653897819258, 344.0572830444582, 345.1602956243223, 345.6422602606303, 348.122730718589, 12019.399030048484, 12321.938390308058, 14896.5531034069, 15192.468263610775, 16792.832071679295, 12357.629271121881, 14763.261836908165, 14972.0, 15034.699306013874, 15046.322915468803, 3060.219643990785, 3512.964870351302, 3523.8061906595126, 3543.6279190684995, 5025.472325405816, 3392.694657480826, 3470.097774578615, 5080.949190508103, 5150.948490515103, 5152.278680984665, 5200.973995130019, 5345.358556973169, 5364.6781193128345, 5366.248725178478, 5376.569874410038, 5216.843494695166, 5328.147496400596, 5329.120695085307, 5332.786688532474, 5359.437259087778, 5129.717865517395, 5153.510416510426, 5157.329547158845, 5160.48395160481, 5161.354830646169, 11741.060715142768, 13005.0, 17337.78635495516, 19085.0, 19116.33092841744, 1809.2401191499603, 1837.4946889605333, 1921.3755529452983, 1935.371004423568, 1966.0759443061738, 9053.818923621491, 9391.859122113174, 10547.103496202755, 12701.555445559454, 12977.480900763958, 1796.0929730486152, 1800.53186171595, 1918.7121931710356, 1957.7063440483898, 2008.9196432142696, 53590.0, 55200.0, 56042.71978640121, 56530.0, 57069.71465142689, 9862.211023118134, 9880.703578892644, 9889.554970026365, 9901.207903367713, 9914.0, 12452.190607610477, 12457.626271211879, 12473.126881118416, 12483.0, 12489.0, 6710.060591517192, 6717.261101278856, 6721.361470660279, 6755.459563234929, 6770.8645827084165, 6289.55973081889, 6401.3278605746655, 6401.7119229633845, 6419.358064193637, 6454.386833250834, 4145.316022856195, 4214.494260688737, 4214.536400995888, 4238.766867822238, 4262.168877069003, 1611.105836260863, 1672.8828981971146, 1688.451253342644, 1718.321263101068, 1723.414039226669, 816.3061397811813, 852.0627309958995, 906.4833045164324, 912.4890061565544, 1004.2618675273668, 15512.638258035471, 15907.840921590867, 16093.195340232942, 16174.353025879069, 16319.34722611106, 763.5402121275112, 793.2701914238914, 840.2815592668303, 854.2525290370926, 873.816498535302, 7635.961820190974, 8612.956935215283, 8676.566171691391, 8794.296456283482, 8808.647654093893, 508449.0, 511212.0, 528387.0, 528819.0, 530178.0, 70610.29389706037, 70875.64562177156, 72571.63714181501, 73888.63055684687, 76137.61931190308, 1030.5620111452602, 1049.6483677967967, 1050.7478205230689, 1056.7041228456044, 1058.1059005140798, 13738.725225495235, 14201.644958876112, 14222.928885355921, 14397.568072957829, 14401.42394304216, 31649.0, 32334.029979100666, 32735.0, 33680.83159584186, 34268.82865585656, 41738.373924391766, 41888.581114189685, 42149.789251053546, 43221.78389108034, 47503.0, 8563.657453702031, 8787.0, 8933.240674542736, 8940.418872773249, 8943.642254309754, 10487.475626218811, 10497.212709047004, 10502.632407865687, 10515.94742026285, 10644.361338319726, 12263.877361226274, 13480.123791953492, 13782.0, 13864.861351386357, 13965.231912244924, 11982.880171198176, 11987.22083064598, 12448.190867593577, 12520.749585008067, 12785.552505662257, 12710.110292279453, 13299.0, 13775.106201785675, 14109.29453527299, 14176.929115354356, 7068.151821781419, 8137.430379873352, 8755.474671519729, 8767.079456656958, 8936.508492033001, 11733.589324373606, 11948.34284114382, 12240.693982650506, 13287.202767833574, 13380.799288010492], "unit": "ms", "name": "jquery.html", "value": 8051.752461768844}, {"lowerIsBetter": false, "replicates": [1393.0, 1424.7079348733512, 1458.0376951212202, 1550.5658415643625, 1701.9234134463957, 5939.52483801296, 6650.733970641175, 6778.0, 6798.830029249271, 6805.761798337059, 6877.346652068058, 6913.619750913697, 6969.860602787941, 6981.022656828048, 6991.196012458556, 2074.8132668059834, 2102.55846272283, 2103.14822496889, 2103.7896210378995, 2104.642210824156, 1957.4421289932372, 2091.623507768601, 2100.28590279305, 2104.2424727098232, 2111.42991392324, 2058.3516192399347, 2087.7703452620276, 2097.538541520863, 2098.443912363225, 2102.148629804924, 2060.464279287381, 2077.7714451410334, 2079.5736873940805, 2079.729635147436, 2089.5716378142442, 2024.9291274805312, 2039.5716899451133, 2049.846261530391, 2051.4871282179456, 2054.527458684496, 5850.473457388813, 6042.6978651067275, 6851.07510486083, 6891.483138764613, 6892.069570607954, 4125.5874412558505, 4261.786910654455, 4264.360345948102, 4264.658827293809, 4272.743635381887, 2814.6622405311496, 2822.6753923298675, 2851.6720577133688, 2852.2441552988475, 2900.3329234276234, 876.430320291809, 876.7808047988003, 877.9078196789372, 889.0798024045082, 907.2968449451728, 9418.387804792666, 9539.09378609038, 9551.0, 9552.665656701982, 9569.138777509988, 3873.9806300968316, 3887.7667339959694, 3925.0, 3930.5872883346838, 4007.338789099824, 8237.711680091168, 8243.340532757366, 8250.133735957757, 8251.546164960864, 8267.379946504036, 4299.376590394375, 4303.2469317869245, 4312.978435107867, 4315.07225946423, 4316.697831151852, 3922.7057970652313, 3922.823472943667, 3928.3321835287497, 3928.7053470989217, 3934.252492026506, 3296.9284982380823, 3300.5709257796334, 3319.4522903720617, 3331.866725331008, 3345.1637090727318, 1093.781243751253, 1096.5339730614617, 1098.6374496416163, 1104.320842681745, 1112.5494174859195, 896.1397058823602, 980.612658000086, 1146.0316032952142, 1159.9014083802801, 1168.1705988747915, 6648.202215734143, 6769.72921083161, 6787.490938179656, 6787.6266805325195, 6788.0, 1039.4906495817147, 1052.4790228836775, 1058.5765693722572, 1077.2943721862193, 1079.1959989807488, 4852.223644216909, 5241.528262456397, 5300.1519756838725, 5304.336957880265, 5313.628046036741, 7389.963050184715, 8436.662533498591, 8495.0, 8495.872561911576, 8513.212225432728, 8203.876941845878, 8262.380321475914, 8324.417290789708, 8327.875736775579, 8333.291670207978, 6406.775762848278, 6599.703013364506, 6603.867922641521, 6643.7674681385915, 6665.233498147678, 6643.6144770408855, 6645.036469711768, 6707.832304192434, 6710.429613482908, 6714.429273511806, 7514.248575142442, 7532.585707786125, 7605.6577454013595, 7656.310932016146, 7666.846663066596, 7464.253574642492, 7584.848303033798, 7770.922290777246, 7771.0, 7774.0, 6219.657918814328, 6221.06683997404, 6242.406971337716, 6260.40526150015, 6271.122042913905, 6876.724931002704, 6915.654217289015, 6917.066196063467, 6929.757458488929, 6966.825829354104, 6440.742370305323, 6506.512011599244, 6571.0, 6625.900611490928, 6650.667466626553, 6317.7157027932935, 6429.9678501607195, 6432.324605916311, 6546.312637173219, 6568.47452203813, 6377.521685873671, 6428.646424446701, 6437.034444833313, 6438.066480360415, 6446.613203207822, 5811.099279611667, 5923.614965027259, 5924.822255332347, 6018.8194354169445, 6044.516438684983, 5988.101784732325, 6024.518038556993, 6024.819255422169, 6031.457168854824, 6037.849053773691], "unit": "ms", "name": "mootools.html", "value": 4089.3021599729327}, {"lowerIsBetter": false, "replicates": [312.65920147039725, 316.0408161230665, 317.13422356965486, 317.51103300916577, 318.7450039968025, 5300.575953923687, 5313.282706834576, 5463.562914966803, 5545.805896793608, 5572.359178694452, 5233.79064837407, 5373.677579345242, 5383.81156659517, 5391.81128660497, 5392.56859451244, 4033.2135233629456, 4126.669866410695, 4209.768462734556, 4216.810243539033, 4219.936700949488, 4121.072758629314, 4214.704970652056, 4216.599423054805, 4221.662267018631, 4224.704270701052, 4165.146145040275, 4171.103212809246, 4174.582541745816, 4181.0592616661315, 4189.79051047448, 4177.5613560576, 4178.749275043507, 4179.79101044948, 4180.561041090672, 4186.392973018896, 3651.543557055368, 3653.06846754076, 3655.214128962286, 3661.0847288177956, 3663.377225871608, 5096.286519887219, 5217.087009773312, 5248.65883717561, 5257.631965762398, 5266.210068489719, 4817.879553011167, 4821.63837712173, 4823.662343635947, 4823.686460380064, 4824.7828847701585, 5393.5954803389905, 5548.55611551075, 5755.884882302373, 5766.423357664242, 5766.740496677659, 3830.2148059647984, 3868.9806550967346, 3881.126746482047, 3881.6894648428342, 3933.960660393388, 5960.195373624592, 6015.879682406371, 6024.939750602525, 6040.607360521552, 6043.244594425697, 4102.159057393227, 4103.815328310233, 4104.4664193654635, 4106.281400754856, 4109.589041095866, 4014.6788256939376, 4165.250254954077, 4166.416701661769, 4172.395002724648, 4174.415581818487, 4757.14371413142, 4758.0, 4758.905451746048, 4765.166095933268, 4776.426828780569, 5690.857728556819, 5709.600327977002, 5719.227904232958, 5723.284589426322, 5723.59934804568, 1447.9420823167166, 1484.1095342794454, 1484.9628759280888, 1485.4875068101487, 1486.405437824857, 1001.2290536287164, 1001.6544292219173, 1001.9398836069859, 1004.7689031522791, 1027.3835698580792, 5026.52248036436, 5032.370953630796, 5039.748012599429, 5042.520960508746, 5043.697378157322, 5947.672877991666, 5952.10718392236, 5957.314908785545, 5959.46364827159, 5963.880722385528, 5003.674761140514, 5023.673461225008, 5027.4469808321055, 5031.77357018935, 5036.219385995177, 3137.450946084426, 3188.6970737779875, 3215.951760723591, 3219.227385427527, 3222.2910959588853, 5611.298587676541, 5613.775448982076, 5627.690477023803, 5631.155326701028, 5631.380548139701, 6098.664573448415, 6118.816435506942, 6124.5100391968535, 6126.571140020156, 6127.387261273837, 5482.862928426821, 5609.523190528851, 5623.803166889139, 5629.0, 5632.04255276604, 5716.8570785729025, 5877.35349111606, 5934.436228558453, 5941.702914854326, 5942.465178133989, 5742.28221472316, 5830.679312637845, 5856.94143058581, 5870.677112758668, 5872.471477567039, 5647.915281270866, 5649.12438572022, 5652.0, 5653.406392328746, 5671.319441667027, 4100.610442008005, 4131.5455299917585, 4136.31750761121, 4139.503259608746, 4141.130362623762, 5780.335261444988, 5963.373845746134, 5988.5508586855285, 6013.548983826318, 6018.879622407615, 5763.596548241583, 5773.076307790733, 5775.797847075501, 5779.2198053263955, 5780.421957804186, 5765.0, 5773.364929857797, 5775.0471172257785, 5777.162311464898, 5781.4507621775865, 5478.178273259043, 5621.128725047624, 5647.20939068539, 5651.039323315129, 5652.576056795675, 5795.420457954339, 5798.0, 5807.361190268983, 5811.331696854747, 5813.418658134153, 5658.066419040812, 5658.40586738403, 5667.291588551431, 5669.943300567106, 5670.121131224667], "unit": "ms", "name": "prototype.html", "value": 4300.56877801143}, {"lowerIsBetter": false, "replicates": [666.163964224898, 671.9496037797165, 700.5586480517275, 729.6133049483775, 744.8473063022082, 11843.644690659283, 11951.581694640689, 11983.520659173622, 12000.0, 12015.098867584922, 13322.13406128601, 13439.462421503153, 13443.529476468326, 13474.461021559126, 13499.932500337509, 636.0332294911732, 644.3813938618931, 797.2824457987799, 811.7118422959853, 812.1350761439078, 770.5530792140545, 785.2108630826012, 791.3669064748207, 791.9049714034323, 792.0178978067185, 841.5161282262693, 847.5846835050811, 847.9236868681818, 848.0374774630777, 849.032103402119, 658.2265837640753, 664.5348256220641, 834.5993922917033, 836.523181786382, 855.4567849415604, 628.6008384675719, 628.6950828848005, 628.8616504369031, 629.2449061126621, 630.180765005491, 11341.659750207507, 11659.417029148508, 11677.88322116785, 11766.470508827124, 11794.174407791457, 11583.305001699924, 11893.286402815858, 12017.158798884082, 12243.571474998333, 12625.24248545081, 9663.516824158763, 9733.124018838267, 9814.263930205192, 9836.409815411027, 9863.40819550822, 3324.966750332514, 3358.865645374182, 3371.8819841305435, 3439.0, 3477.565304336958, 43031.0, 43063.0, 43264.78367608173, 43787.34318985218, 43856.56143438556, 9805.558749856273, 9966.0, 10001.49992500372, 10055.245856560787, 10186.796264074677, 17445.21496532659, 17462.214200361013, 17527.73708394375, 17540.386086486913, 17586.296548138187, 6481.967590162019, 6582.24304205013, 6647.434968027772, 6787.830304242433, 6836.179658440919, 3620.601733809279, 3640.7997560133917, 3661.7253705972157, 3682.355587772129, 3698.14942563212, 2858.2711408591094, 2930.077025736886, 2931.5016447204025, 2935.324875278698, 2935.691752365971, 514.1362510981512, 515.6184423526563, 526.0, 531.3889027618193, 531.4340227657532, 498.7705306419693, 527.8284557518822, 594.7323704333068, 606.9908951365733, 666.5101150654363, 8114.188581141839, 8177.509349439053, 8263.876041859377, 8273.669053237803, 8380.664773409117, 407.7696101702588, 501.90212908482494, 604.6100265328838, 640.3724350136891, 642.2966851297822, 3613.2050948791225, 3858.9421158682644, 3912.1002169501176, 4035.5762644922447, 4207.453031105937, 49856.750716246184, 50287.74856125769, 51294.230586541235, 51569.48430515722, 51629.741851290506, 41380.1723965519, 41511.58488415137, 41667.583324166975, 42205.155896882505, 44540.0, 40792.18415631671, 41641.58358416438, 43548.3467747984, 43904.0, 43918.12163756771, 8047.195280471906, 8256.215659512336, 8627.827443451222, 8815.250703690259, 8874.06822283651, 31764.205894852814, 32448.35103297968, 32874.50688239726, 33210.33579328448, 34085.65914340825, 36946.8152659235, 37301.067473313386, 39336.803315983234, 40425.39361909633, 42682.78658606687, 10482.52828622729, 10523.263371563917, 10614.097801686634, 10842.457877106272, 11010.559577616805, 11540.653780386601, 11613.825792612948, 11715.414229288672, 11802.76394472123, 12340.382980850742, 9879.753006174904, 10130.6454274103, 10153.796924061626, 10853.34879907208, 11214.046806021579, 10911.836322455329, 11047.226694131334, 11090.611828585961, 11439.199256052329, 11559.826602601135, 10950.0, 11060.834087488533, 11250.549978000789, 11327.716807079889, 11521.827172592586, 9534.332596718163, 9579.90420095818, 9749.512524373611, 9948.850767238642, 10043.648472303434, 9299.30255230874, 9426.905730942877, 9593.904060959301, 9702.417854928726, 9717.319787615083], "unit": "ms", "name": "yui.html", "value": 5908.519698396444}], "name": "dromaeo_css", "value": 6361.267703806256}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [109.0, 114.0, 106.0, 113.0, 113.0, 112.0, 100.0, 114.0, 105.0, 111.0], "unit": "ms", "name": "ai-astar", "value": 109.7}, {"lowerIsBetter": true, "replicates": [155.0, 142.0, 158.0, 165.0, 129.0, 151.0, 156.0, 131.0, 185.0, 135.0], "unit": "ms", "name": "audio-beat-detection", "value": 150.7}, {"lowerIsBetter": true, "replicates": [163.0, 162.0, 162.0, 163.0, 161.0, 160.0, 161.0, 162.0, 162.0, 161.0], "unit": "ms", "name": "audio-dft", "value": 161.7}, {"lowerIsBetter": true, "replicates": [73.0, 73.0, 86.0, 93.0, 72.0, 72.0, 75.0, 103.0, 91.0, 73.0], "unit": "ms", "name": "audio-fft", "value": 81.1}, {"lowerIsBetter": true, "replicates": [91.0, 92.0, 128.0, 92.0, 93.0, 92.0, 127.0, 91.0, 92.0, 133.0], "unit": "ms", "name": "audio-oscillator", "value": 103.1}, {"lowerIsBetter": true, "replicates": [110.0, 109.0, 110.0, 109.0, 108.0, 110.0, 109.0, 110.0, 110.0, 110.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 109.5}, {"lowerIsBetter": true, "replicates": [148.0, 148.0, 146.0, 147.0, 147.0, 147.0, 146.0, 147.0, 147.0, 147.0], "unit": "ms", "name": "imaging-darkroom", "value": 147.0}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 95.0, 95.0, 96.0, 95.0, 95.0, 95.0, 95.0], "unit": "ms", "name": "imaging-desaturate", "value": 95.4}, {"lowerIsBetter": true, "replicates": [70.0, 72.0, 69.0, 70.0, 70.0, 69.0, 71.0, 71.0, 72.0, 69.0], "unit": "ms", "name": "json-parse-financial", "value": 70.3}, {"lowerIsBetter": true, "replicates": [68.0, 69.0, 70.0, 69.0, 69.0, 70.0, 70.0, 69.0, 70.0, 69.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 69.3}, {"lowerIsBetter": true, "replicates": [83.0, 82.0, 82.0, 83.0, 81.0, 82.0, 82.0, 83.0, 84.0, 82.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 82.4}, {"lowerIsBetter": true, "replicates": [120.0, 121.0, 128.0, 116.0, 126.0, 119.0, 127.0, 118.0, 129.0, 119.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 122.3}, {"lowerIsBetter": true, "replicates": [145.0, 142.0, 161.0, 140.0, 150.0, 136.0, 137.0, 149.0, 139.0, 140.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 143.9}, {"lowerIsBetter": true, "replicates": [68.0, 67.0, 70.0, 69.0, 69.0, 69.0, 68.0, 68.0, 68.0, 68.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 68.4}], "name": "kraken", "value": 1514.8000000000002}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [163.26530612244898], "unit": "score", "name": "Richards", "value": 216.22475000000003}, {"lowerIsBetter": false, "replicates": [192.789666473877], "unit": "score", "name": "DeltaBlue", "value": 342.9540660000002}, {"lowerIsBetter": false, "replicates": [279.87685418415896], "unit": "score", "name": "Encrypt", "value": 951.0647130000004}, {"lowerIsBetter": false, "replicates": [5060.606060606061], "unit": "score", "name": "Decrypt", "value": 52.59864071856286}, {"lowerIsBetter": false, "replicates": [1994.0239043824702], "unit": "score", "name": "RayTrace", "value": 371.1033746253746}, {"lowerIsBetter": false, "replicates": [798.0845969672786], "unit": "score", "name": "Earley", "value": 835.078139}, {"lowerIsBetter": false, "replicates": [12493.827160493827], "unit": "score", "name": "Boyer", "value": 53.34338241106715}, {"lowerIsBetter": false, "replicates": [26736.842105263157], "unit": "score", "name": "RegExp", "value": 34.07227362204725}, {"lowerIsBetter": false, "replicates": [625.0], "unit": "score", "name": "Splay", "value": 130.3856}, {"lowerIsBetter": false, "replicates": [4830.917874396136], "unit": "score", "name": "NavierStokes", "value": 307.1879999999999}], "name": "v8_7", "value": 19677.047450797578}]} 04:45:46 INFO - RETURN: dromaeo_css: 6361.27 04:45:46 INFO - RETURN: kraken: 1514.80 04:45:46 INFO - RETURN: v8_7: 19677.05 04:45:46 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,94,35]]", "result": "19677.05"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,94,35]]", "result": "1514.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,94,35]]", "result": "6361.27"}}} 04:45:46 INFO - Return code: 0 04:45:46 INFO - # TBPL SUCCESS # 04:45:46 INFO - Running post-action listener: _resource_record_post_action 04:45:46 INFO - Running post-run listener: _resource_record_post_run 04:45:47 INFO - Total resource usage - Wall time: 1234s; CPU: 13.0%; Read bytes: 0; Write bytes: 508510208; Read time: 0; Write time: 602644 04:45:47 INFO - install - Wall time: 14s; CPU: 15.0%; Read bytes: 0; Write bytes: 158265344; Read time: 0; Write time: 261832 04:45:47 INFO - run-tests - Wall time: 1220s; CPU: 13.0%; Read bytes: 0; Write bytes: 274776064; Read time: 0; Write time: 211584 04:45:47 INFO - Running post-run listener: _upload_blobber_files 04:45:47 INFO - Blob upload gear active. 04:45:47 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 04:45:47 INFO - Copying logs to upload dir... 04:45:47 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1272.012518 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 12 secs) (at 2015-11-23 04:45:47.234255) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-23 04:45:47.237385) ========= 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=cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.008767 build_url: 'https://queue.taskcluster.net/v1/task/5x-VBZGESPCn8UOyyItFsg/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-23 04:45:47.286449) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 04:45:47.286844) ========= 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=cbaddfaace6f82c7d20be4ba000001bb-1448281353.147063-1117581391 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004577 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 04:45:47.337214) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-23 04:45:47.337589) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-23 04:45:47.337935) ========= ========= Total master_lag: 0.21 =========